usenet.goja.nl.eu.org Daily Usenet report

Aug 11 01:00:02 -- Aug 12 00:04:58

Unknown entries from news log file:

First 12 / 12 lines (100.0%)

Aug 11 12:54:06 goja innd[59605]: filter: No Cancel-Key[sha1:X932TuOlYsHEtUqL3+gQZciPMyI= sha256:AT5wR9yXEH3MxnLT6B03ua7TH9qzhxCMmQF/fqMRDMw=] matches Cancel-Lock[sha1:bYXznMb1moREILSArfjHUjtxeNs= sha256:NXpElW9blAbRePoVSzNoBwAOqsgeEMQ8DHjaeW963is=] target=<115euqv$3u1bg$2@dont-email.me>
Aug 11 16:56:05 goja innd[59605]: filter: No Cancel-Key[sha1:Rutj2E51OQQxm4i7ikJKfsWrOhQ= sha256:6REPg2F3S1TxmgZVdCakHX43iR3B0jv8hkx2wMdLsxc=] matches Cancel-Lock[sha1:9+1/Ip49NDxNNsR52yCAj3aJsrk= sha256:gtHhf1wqSSkHtl6SN5zz5uQBB7ln93QaEST43eFnArc=] target=<115fcfr$30hn$1@ss32.dont-email.me>
Aug 11 20:57:22 goja innd[59605]: filter: No Cancel-Key[sha1:hdOSmHAoeo1BZvHNjLHPXwa/caE= sha256:mvK+56O6PC8n3y5rDV/YEmi2U+9LqcjAoi8vR9180yw=] matches Cancel-Lock[sha1:jun4+dMf6I22C/9Xs1u3AiMa98A= sha256:cFMziP8ayr5lCrKu3QJpZo7NDkCj5sKUEL5ptUCjq9M=] target=<115a5g6$2dt8t$1@dont-email.me>
Aug 11 20:57:50 goja innd[59605]: filter: No Cancel-Key[sha1:5Ca+6mO4U5YP0KMVjNsiALxjmEg= sha256:XPnziprjJRAM7LhZsrMouBXONPQGi2RLRsrFYXT6p/s=] matches Cancel-Lock[sha1:Ebh39E0yZlttouAk3mUryaUDklQ= sha256:57W7UiFgpCUou2BP085xw27cTpSWxFf6TpLBV1DncBc=] target=<115c0kg$2v6gf$1@dont-email.me>
Aug 11 20:58:18 goja innd[59605]: filter: No Cancel-Key[sha1:5Ca+6mO4U5YP0KMVjNsiALxjmEg= sha256:XPnziprjJRAM7LhZsrMouBXONPQGi2RLRsrFYXT6p/s=] matches Cancel-Lock[sha1:Ebh39E0yZlttouAk3mUryaUDklQ= sha256:57W7UiFgpCUou2BP085xw27cTpSWxFf6TpLBV1DncBc=] target=<115c0kg$2v6gf$1@dont-email.me>
Aug 11 20:59:16 goja innd[59605]: filter: No Cancel-Key[sha1:QO83cej5zB+8wnmnGNRWW2sRc1M= sha256:5bOkWopPXKanO74cXDvzKibM2fnruQsAGsn0t9KQScQ=] matches Cancel-Lock[sha1:FuOLCbh0lmV1aaXzNNYMFlpxOlE= sha256:/Hm87qxNplO0Dw8OHV3xM2+m9pYHHf4l1qnhmgF5hVs=] target=<115ae0q$2gsrb$1@dont-email.me>
Aug 11 20:59:25 goja innd[59605]: filter: No Cancel-Key[sha1:QO83cej5zB+8wnmnGNRWW2sRc1M= sha256:5bOkWopPXKanO74cXDvzKibM2fnruQsAGsn0t9KQScQ=] matches Cancel-Lock[sha1:FuOLCbh0lmV1aaXzNNYMFlpxOlE= sha256:/Hm87qxNplO0Dw8OHV3xM2+m9pYHHf4l1qnhmgF5hVs=] target=<115ae0q$2gsrb$1@dont-email.me>
Aug 11 20:59:36 goja innd[59605]: filter: No Cancel-Key[sha1:74sEWv6/8DOKF7NUjbDEXG9W5wE= sha256:UYMGdbPSch6xwwaE0UZ/cMSIdRXOqTpSP5WjHCXhB24=] matches Cancel-Lock[sha1:p2qAAteUnRyslHjUuAvCUzKZ0QA= sha256:QEigblGzHaMIJtLC6bvccvXGLH/FpsvpfPjnjeEIG2k=] target=<115cpdu$37prc$1@dont-email.me>
Aug 11 21:00:15 goja innd[59605]: filter: No Cancel-Key[sha1:yC2T/2+kP4MeMB9X/jv5u+ho6Bs= sha256:ZjObmjzNHCTuHVX5Q49Ge7PVADPeqYbFtj1Wu3LI7aU=] matches Cancel-Lock[sha1:4N9Htl5a1u+eXRqY49AQp9n0MRk= sha256:I3G764l9VGYrRFBX7xjnjYdL9tMT0TUJkBbrSkm3rEg=] target=<115br0m$2tgpq$1@dont-email.me>
Aug 11 21:00:26 goja innd[59605]: filter: No Cancel-Key[sha1:yC2T/2+kP4MeMB9X/jv5u+ho6Bs= sha256:ZjObmjzNHCTuHVX5Q49Ge7PVADPeqYbFtj1Wu3LI7aU=] matches Cancel-Lock[sha1:4N9Htl5a1u+eXRqY49AQp9n0MRk= sha256:I3G764l9VGYrRFBX7xjnjYdL9tMT0TUJkBbrSkm3rEg=] target=<115br0m$2tgpq$1@dont-email.me>
Aug 12 00:03:00 goja news2mail[71186]: begin
Aug 12 00:03:00 goja news2mail[37321]: end

Log entries by program:

Program nameLines%LinesSize%Size
nnrpd 11444 45.3%1.2 MB 41.5%
innd 9834 39.0%1.2 MB 42.5%
innfeed 3908 15.5%471.4 KB 15.8%
nocem 30 0.1%3.8 KB 0.1%
inn 19 0.1%4.3 KB 0.1%
news2mail 2 0.0%0.2 KB 0.0%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 7 25238 100.0%2.9 MB100.0%

History cache:

ReasonCount%Count
Positive hits 89810 64.6%
Negative hits 32740 23.5%
Do not exist 16462 11.8%
Cache misses 56 0.0%
TOTAL: 4 139068 100.0%

innd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
artcncl/perl00:00:00.014 0.0%7 0.000 2.000 12.000
article cancel00:00:00.000 0.0%22 0.000 0.000 0.000
article cleanup00:00:00.259 0.0%16462 0.000 0.016 0.051
article logging00:00:00.323 0.0%16481 0.000 0.020 0.053
article parse00:00:00.718 0.0%35648 0.000 0.020 0.046
article write00:00:03.177 0.0%14866 0.081 0.214 0.560
artlog/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
artlog/artcncl/perl00:00:00.000 0.0%7 0.000 0.000 0.000
artlog/artparse00:00:00.000 0.0%1 0.000 0.000 0.000
data move00:00:00.310 0.0%147080 0.000 0.002 0.038
hisgrep/artcncl00:00:00.000 0.0%22 0.000 0.000 0.000
hisgrep/artcncl/perl00:00:00.000 0.0%7 0.000 0.000 0.000
hisgrep/perl00:00:00.005 0.0%37 0.000 0.135 1.000
hishave/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
hishave/artcncl/perl00:00:00.000 0.0%7 0.000 0.000 0.000
hishave/artparse00:00:00.000 0.0%1 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:01.168 0.0%139060 0.001 0.008 0.023
history sync00:00:00.130 0.0%380 0.000 0.342 1.000
history write00:00:01.641 0.0%16459 0.027 0.100 0.233
hiswrite/artparse00:00:00.000 0.0%1 0.000 0.000 0.000
idle22:49:17.468 99.1%147956 336.734 555.283 1363.460
nntp read00:00:02.287 0.0%149868 0.002 0.015 0.049
overview write00:00:02.650 0.0%14866 0.059 0.178 0.465
perl filter00:00:53.416 0.1%16459 2.000 3.245 4.291
python filter00:00:00.973 0.0%16459 0.011 0.059 0.123
site send00:00:01.099 0.0%29759 0.000 0.037 0.198
TOTAL: 2722:50:25.638 99.2%----

innfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.088 0.0%15651 0.000 0.006 0.031
article prepare00:00:00.045 0.0%171800 0.000 0.000 0.002
article read00:00:01.425 0.0%14685 0.027 0.097 0.371
backlog stats00:00:00.416 0.0%290680 0.000 0.001 0.004
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:03.772 0.0%176953 0.010 0.021 0.112
data write00:00:04.146 0.0%165303 0.015 0.025 0.035
idle23:04:10.443 99.9%290680 162.175 285.711 695.990
status file00:00:00.618 0.0%660 0.000 0.936 2.000
TOTAL: 923:04:20.953100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle23:17:07.134 98.3%11630 54.500 7207.836 10499.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:23:50.709 1.7%25497052 0.000 0.056 0.192
readart00:00:00.161 0.0%167 0.486 0.964 1.118
TOTAL: 423:40:58.004100.0%----

Control commands to innd:

CommandNumber
flush 6
flushlogs 2
go 2
logmode 2
lowmark 1
mode 145
name 2
pause 2
paused 2
reload 693
reserve 2
TOTAL: 11 859

Incoming feeds (innd):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1goja-out.feeder.erje.net 569 29360 10379 18011 970 35%144:34:06
2goja-out.news.weretis.net 4 11995 2722 9039 234 22%48:25:46
3news.nntp4.net 1 12691 657 11779 255 5%40:01:33
4newsfeed.bofh.team 15 10946 433 10504 9 3%46:06:42
5news.samoylyk.net 1 15248 198 15045 5 1%23:59:54
6pasdenom.info 2 3285 158 3122 5 4%23:52:31
7news.chmurka.net 1 2751 151 2599 1 5%23:35:22
8news.1d4.us 1 3109 52 2929 128 1%24:00:13
9newsfeed.endofthelinebbs.com 1 2343 49 2274 20 2%13:31:34
10news.quux.org 2 4873 35 4832 6 0%24:01:24
11nntp.terraraq.uk 1 2736 28 2708 0 1%23:59:57
12news.furie.org.uk 1 2473 14 2453 6 0%23:59:57
13news.bbs.nz 2 5571 11 5559 1 0%23:59:38
14newsfeed.dotsrc.org 206 567 3 564 0 0%23:06:59
15goja-out.news.tnetconsulting.net 1 3292 1 3291 0 0%23:59:28
16localhost 1 0 0 0 0 0%00:00:00
TOTAL: 16 809 111240 14891 94709 1640 13%531:15:04
Articles received by server

Incoming volume (innd):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1goja-out.feeder.erje.net30.2 MB0.0 KB6.6 MB36.8 MB 82%3.3 KB
2goja-out.news.weretis.net8.0 MB0.0 KB587.8 KB8.5 MB 93%3.0 KB
3news.nntp4.net1.9 MB0.0 KB2.6 MB4.4 MB 42%5.0 KB
4newsfeed.bofh.team1.2 MB13.2 KB268.6 KB1.5 MB 81%3.4 KB
5news.samoylyk.net1.1 MB0.0 KB7.3 KB1.1 MB 99%5.7 KB
6news.chmurka.net532.0 KB0.0 KB1.0 KB533.0 KB 99%3.5 KB
7newsfeed.endofthelinebbs.com483.2 KB0.0 KB844.1 KB1.3 MB 36%19.2 KB
8pasdenom.info456.7 KB0.0 KB5.6 KB462.3 KB 98%2.8 KB
9news.quux.org233.4 KB0.0 KB223.5 KB456.9 KB 51%11.1 KB
10news.1d4.us149.4 KB0.0 KB394.3 KB543.6 KB 27%3.0 KB
11nntp.terraraq.uk113.4 KB0.0 KB0.0 KB113.4 KB100%4.0 KB
12news.furie.org.uk39.2 KB0.0 KB3.9 KB43.1 KB 90%2.2 KB
13news.bbs.nz22.7 KB0.0 KB5.2 KB27.9 KB 81%2.3 KB
14newsfeed.dotsrc.org17.1 KB0.0 KB0.0 KB17.1 KB100%5.7 KB
15goja-out.news.tnetconsulting.net2.2 KB0.0 KB0.0 KB2.2 KB100%2.2 KB
16localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 1644.3 MB13.2 KB11.4 MB55.8 MB 79%3.5 KB
Incoming volume received by server

Incoming articles (innd):

DateArticles%ArtsArt/secSize%SizeKB/sec
Aug 12 00:00:02 - 00:04:58 16 100.0% 0.0533.8 KB 100.0% 0.11
TOTAL: 00:04:56 16 100.0% 0.0533.8 KB 100.0% 0.11
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1goja-out.feeder.erje.net 3 3 0 0 0 0 0 0 0
TOTAL: 1 3 3 0 0 0 0 0 0 0

Unwanted newsgroups [Top 20]:

NewsgroupCount
linux.kernel.netdev 3
TOTAL: 1 3

Perl filter (innd) [Top 20]:

ReasonCount
EMP (phn path) 269
EMP (md5) 105
Too many newsgroups 81
Too many newsgroups (meow) 6
HTML Multipart 2
No Cancel-Key matches Cancel-Lock. target=<115ae0q$2gsrb$1@dont-email.me> 2
No Cancel-Key matches Cancel-Lock. target=<115br0m$2tgpq$1@dont-email.me> 2
No Cancel-Key matches Cancel-Lock. target=<115c0kg$2v6gf$1@dont-email.me> 2
Cancel of non-existing ID <115bv1g$1us$2@news.kraft-s.ru> 1
Cancel of non-existing ID <115bv26$1us$3@news.kraft-s.ru> 1
Cancel of non-existing ID <115fr9d$28rv$1@news.tambov.ru> 1
Cancel of non-existing ID <115frn3$2a89$1@news.tambov.ru> 1
Cancel of non-existing ID <6a7ac742a6289@samaranews.ru> 1
No Cancel-Key matches Cancel-Lock. target=<115a5g6$2dt8t$1@dont-email.me> 1
No Cancel-Key matches Cancel-Lock. target=<115cpdu$37prc$1@dont-email.me> 1
No Cancel-Key matches Cancel-Lock. target=<115euqv$3u1bg$2@dont-email.me> 1
No Cancel-Key matches Cancel-Lock. target=<115fcfr$30hn$1@ss32.dont-email.me> 1
TOTAL: 17 478

NoCeM on spool:

Issuer (type)NoticesBad PGPCancelSkipTotal
robot@pasdenom.info (spam2)11001212
robot@pasdenom.info (spam3)60099
robot@pasdenom.info (spam4)40044
nocem@eternal-september.org (misplaced_binary)20022
TOTAL: 423002727

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Bad command received
newsfeed.dotsrc.org 40
TOTAL: 1 40
Huge articles
newsfeed.bofh.team 1
TOTAL: 1 1
TOTAL: 2 41

Outgoing feeds (innfeed) by articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.bbs.nz 20112 8914 5824 143 0 137 44%23:08:31
2news.chmurka.net 12805 8782 2927 34 0 10 68%23:09:13
3news.1d4.us 6542 4237 1840 1 0 0 64%23:09:36
4newsfeed.dotsrc.org 6648 3078 826 2212 0 16 46%23:07:00
5newsfeed.bofh.team 6027 2866 2818 5 0 10 47%23:08:00
6news.furie.org.uk 2311 1343 709 1 0 0 58%23:02:56
7pasdenom.info 7398 580 3940 288 0 58 7%23:01:49
8news.nntp4.net 16691 378 5200 8752 0 37 2%23:09:20
9nntp.terraraq.uk 3003 341 1786 341 0 1 11%23:02:25
10feeder.erje.net 4757 223 3966 44 0 5 4%23:06:48
11news.samoylyk.net 10344 143 5700 190 0 121 1%23:07:15
12newsfeed.endofthelinebbs.com 11254 123 5817 33 0 304 1%23:07:00
13news.quux.org 10625 48 6026 8 0 86 0%23:09:12
14weretis.net 3547 27 3358 0 0 0 0%23:05:19
15tnetconsulting.net 3364 2 1941 3 0 4175 0%23:07:46
16gijs.erje.net 0 0 0 0 0 6094 0%23:09:55
TOTAL: 16 125428 31085 52678 12055 0 11054 24%369:52:05
Outgoing feeds (innfeed) by articles

Outgoing feeds (innfeed) by volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.chmurka.net25.8 MB153.6 KB25.9 MB0.3 KB/s3.0 KB23:09:13
2news.bbs.nz22.7 MB215.2 KB22.9 MB0.3 KB/s2.6 KB23:08:31
3news.1d4.us11.7 MB4.8 KB11.7 MB0.1 KB/s2.8 KB23:09:36
4newsfeed.dotsrc.org7.9 MB5.8 MB13.7 MB0.2 KB/s2.7 KB23:07:00
5newsfeed.bofh.team7.8 MB8.1 KB7.8 MB0.1 KB/s2.8 KB23:08:00
6news.furie.org.uk4.9 MB5.2 KB4.9 MB0.1 KB/s3.8 KB23:02:56
7pasdenom.info2.3 MB432.2 KB2.7 MB0.0 KB/s3.2 KB23:01:49
8nntp.terraraq.uk1.1 MB566.4 KB1.7 MB0.0 KB/s2.5 KB23:02:25
9news.nntp4.net990.6 KB26.0 MB27.0 MB0.3 KB/s3.0 KB23:09:20
10feeder.erje.net738.3 KB225.8 KB964.0 KB0.0 KB/s3.6 KB23:06:48
11news.samoylyk.net421.2 KB536.2 KB957.4 KB0.0 KB/s2.9 KB23:07:15
12newsfeed.endofthelinebbs.com278.3 KB81.6 KB359.9 KB0.0 KB/s2.3 KB23:07:00
13news.quux.org267.8 KB15.1 KB282.9 KB0.0 KB/s5.1 KB23:09:12
14weretis.net53.7 KB0.0 KB53.7 KB0.0 KB/s2.0 KB23:05:19
15tnetconsulting.net3.9 KB20.5 KB24.3 KB0.0 KB/s4.9 KB23:07:46
16gijs.erje.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:09:55
TOTAL: 1686.9 MB34.0 MB120.9 MB0.1 KB/s2.9 KB369:52:05
Outgoing feeds (innfeed) by volume

NNRP readership statistics [Top 100]:

SystemConnArtsSizeGroupsPostRejElapsed
12603:6010:6802:4ca5:1a03:73ff:fe28:be0f 6 165611.0 KB 4 0 000:02:18
266.61.98.95 6 23.1 KB 1 0 000:00:49
TOTAL: 2 12 167614.1 KB 5 0 000:03:08

NNRP connection statistics (by domain) [Top 100]:

SystemConnArtsSizeGroupsPostRejElapsed
1unresolved 295 167614.1 KB 5 0 000:23:58
2*.stehlik.co.uk 399 00.0 KB 0 0 023:15:57
3*.66.censys-scanner.com 8 00.0 KB 0 0 000:00:28
4*.199.censys-scanner.com 4 00.0 KB 0 0 000:00:15
5*.e-n-c-r-y-p-t.cc 2 00.0 KB 0 0 000:00:01
6*.stretchoid.com 2 00.0 KB 0 0 000:00:10
7*.erje.net 1 00.0 KB 0 0 000:00:00
8*.scanner.modat.io 1 00.0 KB 0 0 000:00:00
TOTAL: 8 712 167614.1 KB 5 0 023:40:52

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
toma-03.stehlik.co.uk 49.125 30.299 35.64623:15:57
2a03:cfc0:8000:b::c303:dce8 29.707 16.456 0.00000:20:37
2603:6010:6802:4ca5:1a03:73ff:fe28:be0f 0.554 0.201 73.33400:02:18
66.61.98.95 0.517 0.121 0.40900:00:49
32.172.132.66.censys-scanner.com 0.324 0.054 0.00000:00:15
87.155.45.199.censys-scanner.com 0.295 0.036 0.00000:00:15
42.195.132.66.censys-scanner.com 0.200 0.047 0.00000:00:12
165.154.221.175 0.155 0.069 0.00000:00:11
azpdssu8seh3.stretchoid.com 0.119 0.040 0.00000:00:10
server-03.e-n-c-r-y-p-t.cc 0.186 0.040 0.00000:00:01
kotz.erje.net 0.073 0.044 0.00000:00:00
5.226.140.119 0.074 0.008 0.00000:00:00
147.185.132.150 0.072 0.008 0.00000:00:00
194.88.98.106 0.077 0.008 0.00000:00:00
o036.scanner.modat.io 0.090 0.008 0.00000:00:00
80.66.83.80 0.081 0.008 0.00000:00:00
91.238.181.92 0.087 0.009 0.00000:00:00
TOTAL: 17 81.736 47.456 109.38923:40:52

Curious NNRP explorers [Top 20]:

SystemConn
toma-03.stehlik.co.uk 399
2a03:cfc0:8000:b::c303:dce8 275
32.172.132.66.censys-scanner.com 5
87.155.45.199.censys-scanner.com 4
165.154.221.175 3
42.195.132.66.censys-scanner.com 3
azpdssu8seh3.stretchoid.com 2
server-03.e-n-c-r-y-p-t.cc 2
147.185.132.150 1
194.88.98.106 1
5.226.140.119 1
80.66.83.80 1
91.238.181.92 1
kotz.erje.net 1
o036.scanner.modat.io 1
TOTAL: 15 700

NNRP unrecognized commands (by host) [Top 20]:

SystemConn
32.172.132.66.censys-scanner.com 3
165.154.221.175 2
80.66.83.80 1
91.238.181.92 1
azpdssu8seh3.stretchoid.com 1
TOTAL: 5 8

NNRP unrecognized commands (by command) [Top 20]:

CommandCount
^C 2
^V^C^A 2
*M-^A?^D?WP~l ?M-^@?M-^G^\M-^P=?g?}^?M-?U?M-^T!?-^ZP?^L3z?... 1
?^T 1
MGLNDD_116.202.108.142_119 1
^S^C^S^A^S^B^A 1
TOTAL: 6 8

NNRP client timeouts [Top 20]:

SystemConnPeer
32.172.132.66.censys-scanner.com 1 4
5.226.140.119 1 1
80.66.83.80 1 1
87.155.45.199.censys-scanner.com 1 3
91.238.181.92 1 1
TOTAL: 5 5 14

Newsgroup request counts (by hierarchy) [Top 100]:

HierarchyCountPct
1alt 100 59.9%
2linux 37 22.2%
3uk 19 11.4%
4seattle 9 5.4%
5it 2 1.2%
TOTAL: 5 167100.0%

Newsgroup request counts (by newsgroup) [Top 100]:

NewsgroupCount
1alt.computer.workshop 100
2linux.debian.vote 37
3uk.religion.christian 19
4seattle.politics 9
5it.economia.borsa 2
TOTAL: 5 167
innreport from INN 2.7.3 based on initial work (©) 1996-2001 by Fabien Tassin <fta@sofaraway.org> and enhanced by several contributors since then
Local contact: usenet@goja.nl.eu.org