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

Aug 12 01:00:00 -- Aug 13 00:04:53

Unknown entries from news log file:

First 9 / 9 lines (100.0%)

Aug 12 01:17:57 goja innd[59605]: filter: No Cancel-Key[sha1:+Ah7dbLsW0YlW2m5lap2+4u7Wjo= sha256:+ZRCZJc4i8kWIcwyLe/2PjZSLW0dpfpFYu3r2dg32Iw=] matches Cancel-Lock[sha1:aN9YSqDHZkmQ5uR90Qn68QnhPSc= sha256:e+tWPbw4lxnL7QtdXt/1wxAFcrbCkHBtI6y+UTYAeIk=] target=<115gadk$b61t$4@dont-email.me>
Aug 12 10:42:04 goja innd[59605]: filter: No Cancel-Key[sha1:p6eEbg/ksKhjrgjqBRRcd00GXYk= sha256:17AxriL5B511fZ3kBeEM9zFXUlyfvTdtp8Wro85gYXI=] matches Cancel-Lock[sha1:/1PKp6lRfJTbaEOzGODjkT5Pupk= sha256:lsQjQaTSCjvdIvfzn5Rxs8sWVsVHLJcMT59t67a+QsA=] target=<115h2t1$j4mb$1@dont-email.me>
Aug 12 10:42:10 goja innd[59605]: filter: No Cancel-Key[sha1:p6eEbg/ksKhjrgjqBRRcd00GXYk= sha256:17AxriL5B511fZ3kBeEM9zFXUlyfvTdtp8Wro85gYXI=] matches Cancel-Lock[sha1:/1PKp6lRfJTbaEOzGODjkT5Pupk= sha256:lsQjQaTSCjvdIvfzn5Rxs8sWVsVHLJcMT59t67a+QsA=] target=<115h2t1$j4mb$1@dont-email.me>
Aug 12 13:47:39 goja innd[59605]: filter: No Cancel-Key[sha1:ARuarDE8QU5AW2cEsv8hyM4KWkA= sha256:3qwKSs7vDn/vrLV1i7p+rhb0tcuCz3bYeyfeGuo/lDo=] matches Cancel-Lock[sha1:kTh+J2HMcPCJCcp5YLxBTE9AQ6o= sha256:x7LlSvMSjxA2zUMZS0iskRk2CdvYb3g75EIQeJCKhb8=] target=<k0uz0u9zfdnw$.ipkg25qkmug5$.dlg@40tude.net>
Aug 12 16:25:02 goja innd[59605]: filter: No Cancel-Key[sha1:KoYZN3risY7lpNPTY+n/WiGx2U8= sha256:kcbguMGhdzuRA9WCKjSSHqOwyjKn1nkqqaiKgh5TyDE=] matches Cancel-Lock[sha1:7wf9MM4NjtA+Cmhr+ISXqN9+CGk= sha256:kNI59iuLbbP/jcFwEG1aHaMX9XQr+NWv3/qJxmOJxkk=] target=<115hvjc$se1u$2@dont-email.me>
Aug 12 16:28:51 goja innd[59605]: filter: No Cancel-Key[sha1:WE0/C2lnwJyq9bI/eCCsu+ARc1Q= sha256:gjj0xRWk0xXYR/Eh/xamXtFmpvlxY8TYhkznZH9mW1g=] matches Cancel-Lock[sha1:475WyqUkNhoxIC+1xkiJ7IsMMhM= sha256:kQHcTbnIbg65UkYWwPOsd9+fzrEExw/JaQlWHPkS0bU=] target=<115hvbl$se1u$1@dont-email.me>
Aug 12 19:03:06 goja innd[59605]: filter: No Cancel-Key[sha1:ECuiYhZDiYZ0yscfH7Xb9qKAO/U= sha256:zou/uPzsgkegY4kHOKoxt0Y1LeB2G4xe5VP33Ap1zv0=] matches Cancel-Lock[sha1:2lo94jUJMoXzvNUGWC99654DS9I= sha256:mK3oDYA5tMT0hVpgizCjHk4OHKidOWQgke5aFKp1iUs=] target=<115i8oq$u6m0$2@dont-email.me>
Aug 13 00:03:00 goja news2mail[48960]: begin
Aug 13 00:03:00 goja news2mail[71186]: end

Log entries by program:

Program nameLines%LinesSize%Size
nnrpd 11600 45.1%1.3 MB 42.1%
innd 10216 39.7%1.3 MB 42.8%
innfeed 3828 14.9%453.8 KB 14.8%
nocem 41 0.2%4.5 KB 0.1%
inn 28 0.1%6.3 KB 0.2%
news2mail 2 0.0%0.1 KB 0.0%
controlchan 1 0.0%0.0 KB 0.0%
TOTAL: 7 25716 100.0%3.0 MB100.0%

History cache:

ReasonCount%Count
Positive hits 93027 64.4%
Negative hits 32342 22.4%
Do not exist 18992 13.2%
Cache misses 33 0.0%
TOTAL: 4 144394 100.0%

innd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
artcncl/perl00:00:00.017 0.0%21 0.000 0.810 1.273
article cancel00:00:00.001 0.0%36 0.000 0.028 0.500
article cleanup00:00:00.294 0.0%18660 0.000 0.016 0.062
article logging00:00:00.419 0.0%18674 0.000 0.022 0.082
article parse00:00:02.395 0.0%84911 0.000 0.028 0.058
article write00:00:03.481 0.0%17421 0.087 0.200 0.556
artlog/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
artlog/artcncl/perl00:00:00.000 0.0%21 0.000 0.000 0.000
artlog/artparse00:00:00.005 0.0%331 0.000 0.015 0.023
data move00:00:00.425 0.0%202739 0.000 0.002 0.026
hisgrep/artcncl00:00:00.001 0.0%36 0.000 0.028 0.500
hisgrep/artcncl/perl00:00:00.000 0.0%21 0.000 0.000 0.000
hisgrep/perl00:00:00.001 0.0%49 0.000 0.020 0.091
hishave/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
hishave/artcncl/perl00:00:00.001 0.0%21 0.000 0.048 0.091
hishave/artparse00:00:00.002 0.0%330 0.000 0.006 0.010
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:01.240 0.0%144043 0.001 0.009 0.021
history sync00:00:00.134 0.0%370 0.000 0.362 1.000
history write00:00:01.844 0.0%18659 0.034 0.099 0.230
hiswrite/artparse00:00:00.042 0.0%330 0.000 0.127 0.143
idle22:57:41.475 99.0%200029 21.674 413.247 1435.214
nntp read00:00:03.292 0.0%202892 0.006 0.016 0.039
overview write00:00:03.221 0.0%17421 0.094 0.185 0.492
perl filter00:01:03.380 0.1%18658 2.651 3.397 4.378
python filter00:00:01.130 0.0%18658 0.012 0.061 0.175
site send00:00:01.235 0.0%34881 0.007 0.035 0.093
TOTAL: 2722:59:04.035 99.1%----

innfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.090 0.0%23786 0.000 0.004 0.029
article prepare00:00:00.053 0.0%185504 0.000 0.000 0.002
article read00:00:01.550 0.0%17111 0.023 0.091 0.176
backlog stats00:00:00.530 0.0%327128 0.000 0.002 0.004
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:04.601 0.0%199026 0.011 0.023 0.184
data write00:00:04.449 0.0%183786 0.014 0.024 0.043
idle23:04:19.477 99.9%327128 107.244 253.905 740.080
status file00:00:00.636 0.0%653 0.000 0.974 2.000
TOTAL: 923:04:31.386100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle22:47:00.144 98.4%13529 45.000 6062.543 10085.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:22:55.446 1.6%25188970 0.000 0.055 0.263
TOTAL: 323:09:55.590100.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 574 31777 13273 17761 743 41%151:12:51
2goja-out.news.weretis.net 5 10236 1750 8346 140 17%43:05:06
3newsfeed.bofh.team 16 10809 1245 9172 392 11%51:41:33
4news.samoylyk.net 2 23698 354 23343 1 1%35:34:36
5news.nntp4.net 1 1948 190 1730 28 9%07:58:22
6newsfeed.endofthelinebbs.com 2 4982 158 4819 5 3%23:59:39
7pasdenom.info 2 3183 135 3048 0 4%23:49:57
8news.chmurka.net 2 2903 100 2803 0 3%23:59:23
9nntp.terraraq.uk 1 3042 89 2953 0 2%23:59:57
10news.1d4.us 1 3262 61 3089 112 1%24:00:15
11news.quux.org 2 5056 25 5025 6 0%23:58:10
12news.furie.org.uk 2 2681 23 2637 21 0%23:59:34
13news.bbs.nz 1 5987 8 5979 0 0%23:59:47
14newsfeed.dotsrc.org 203 541 5 536 0 0%23:10:43
15goja-out.news.tnetconsulting.net 1 3386 1 3385 0 0%23:43:46
16localhost 1 0 0 0 0 0%00:00:00
TOTAL: 16 816 113491 17417 94626 1448 15%528:13:39
Articles received by server

Incoming volume (innd):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1goja-out.feeder.erje.net36.6 MB0.0 KB3.8 MB40.4 MB 90%3.0 KB
2goja-out.news.weretis.net5.2 MB0.0 KB365.8 KB5.6 MB 93%3.0 KB
3newsfeed.bofh.team3.7 MB68.4 KB232.9 MB236.7 MB 1%148.1 KB
4news.samoylyk.net2.0 MB0.0 KB1.3 KB2.0 MB 99%5.6 KB
5news.nntp4.net682.4 KB18.1 KB239.1 KB939.5 KB 72%4.3 KB
6pasdenom.info440.6 KB0.0 KB0.0 KB440.6 KB100%3.3 KB
7newsfeed.endofthelinebbs.com417.8 KB0.0 KB51.0 KB468.8 KB 89%2.9 KB
8nntp.terraraq.uk410.5 KB0.0 KB0.0 KB410.5 KB100%4.6 KB
9news.chmurka.net259.1 KB0.0 KB0.0 KB259.1 KB100%2.6 KB
10news.1d4.us160.0 KB0.0 KB352.5 KB512.4 KB 31%3.0 KB
11news.quux.org51.9 KB0.0 KB13.7 KB65.6 KB 79%2.1 KB
12news.furie.org.uk37.5 KB0.0 KB14.3 KB51.8 KB 72%1.2 KB
13news.bbs.nz22.2 KB0.0 KB0.0 KB22.2 KB100%2.8 KB
14newsfeed.dotsrc.org10.8 KB0.0 KB0.0 KB10.8 KB100%2.2 KB
15goja-out.news.tnetconsulting.net2.6 KB0.0 KB0.0 KB2.6 KB100%2.6 KB
16localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 1650.0 MB86.4 KB237.7 MB287.8 MB 17%15.6 KB
Incoming volume received by server

Incoming articles (innd):

DateArticles%ArtsArt/secSize%SizeKB/sec
Aug 13 00:00:00 - 00:04:53 28 100.0% 0.1078.9 KB 100.0% 0.27
TOTAL: 00:04:53 28 100.0% 0.1078.9 KB 100.0% 0.27
Incoming articles
Incoming articles (size)

Perl filter (innd) [Top 20]:

ReasonCount
EMP (phn path) 197
Too many newsgroups 90
EMP (md5) 82
Too many newsgroups (meow) 8
HTML Multipart 7
Binary: misplaced binary 2
No Cancel-Key matches Cancel-Lock. target=<115h2t1$j4mb$1@dont-email.me> 2
Cancel of non-existing ID <115he2k$6rh$1@news.kraft-s.ru> 1
Cancel of non-existing ID <EW40Znc7sby7YEGWdjX5xIvTvI4@jntp> 1
Cancel of non-existing ID <KUP4GgWyJnEYEbiYUOnBInS2Aus@jntp> 1
Cancel of non-existing ID <NeS7eKQmaWkQ7txDQ7LxlaPbtcQ@jntp> 1
Cancel of non-existing ID <RM0sWknYXDwNnBJhqSnQV-OwuFc@jntp> 1
Cancel of non-existing ID <cF1LcgKkHEP_ybZKVzUZpO0yRdI@jntp> 1
No Cancel-Key matches Cancel-Lock. target=<115gadk$b61t$4@dont-email.me> 1
No Cancel-Key matches Cancel-Lock. target=<115hvbl$se1u$1@dont-email.me> 1
No Cancel-Key matches Cancel-Lock. target=<115hvjc$se1u$2@dont-email.me> 1
No Cancel-Key matches Cancel-Lock. target=<115i8oq$u6m0$2@dont-email.me> 1
No Cancel-Key matches Cancel-Lock. target=<k0uz0u9zfdnw$.ipkg25qkmug5$.dlg@40tude.net> 1
TOTAL: 18 399

NoCeM on spool:

Issuer (type)NoticesBad PGPCancelSkipTotal
robot@pasdenom.info (spam2)25002727
robot@pasdenom.info (spam3)60066
robot@pasdenom.info (spam4)20022
TOTAL: 333003535

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Bad command received
newsfeed.dotsrc.org 48
TOTAL: 1 48
Huge articles
newsfeed.bofh.team 330
TOTAL: 1 330
TOTAL: 2 378

Outgoing feeds (innfeed) by articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.bbs.nz 22605 11421 5871 74 0 56 50%23:08:49
2news.chmurka.net 15602 11179 2997 37 0 13 71%23:08:31
3news.1d4.us 6745 3915 2082 1 0 4 58%23:07:52
4newsfeed.dotsrc.org 6483 2909 698 2424 0 0 44%23:05:47
5news.furie.org.uk 1993 951 761 0 0 0 47%23:02:39
6nntp.terraraq.uk 3033 490 1632 285 0 25 16%23:04:49
7newsfeed.bofh.team 4964 456 4208 0 0 0 9%23:06:55
8feeder.erje.net 4969 248 3897 21 0 5 4%23:06:35
9pasdenom.info 7942 232 4215 163 0 26 2%23:06:33
10news.nntp4.net 19759 225 5712 11315 0 14 1%23:09:06
11newsfeed.endofthelinebbs.com 11165 60 5811 17 0 223 0%23:07:54
12news.samoylyk.net 9862 51 5609 4 0 8 0%23:06:24
13news.quux.org 10529 39 5949 18 0 41 0%23:08:55
14weretis.net 4351 33 4118 2 0 0 0%23:06:24
15tnetconsulting.net 13819 4 10393 21 0 1542 0%23:09:05
16gijs.erje.net 0 0 0 0 0 6013 0%23:09:55
TOTAL: 16 143821 32213 63953 14382 0 7970 22%369:56:13
Outgoing feeds (innfeed) by articles

Outgoing feeds (innfeed) by volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.chmurka.net30.5 MB834.1 KB31.3 MB0.4 KB/s2.9 KB23:08:31
2news.bbs.nz28.1 MB103.8 KB28.2 MB0.3 KB/s2.5 KB23:08:49
3news.1d4.us10.7 MB4.8 KB10.7 MB0.1 KB/s2.8 KB23:07:52
4newsfeed.dotsrc.org7.4 MB6.7 MB14.2 MB0.2 KB/s2.7 KB23:05:47
5news.furie.org.uk3.4 MB0.0 KB3.4 MB0.0 KB/s3.6 KB23:02:39
6nntp.terraraq.uk1.5 MB387.1 KB1.9 MB0.0 KB/s2.5 KB23:04:49
7pasdenom.info1.2 MB329.6 KB1.5 MB0.0 KB/s4.0 KB23:06:33
8newsfeed.bofh.team1.1 MB0.0 KB1.1 MB0.0 KB/s2.6 KB23:06:55
9feeder.erje.net810.2 KB211.5 KB1021.8 KB0.0 KB/s3.8 KB23:06:35
10news.nntp4.net560.2 KB32.2 MB32.7 MB0.4 KB/s2.9 KB23:09:06
11news.quux.org190.8 KB34.6 KB225.4 KB0.0 KB/s4.0 KB23:08:55
12newsfeed.endofthelinebbs.com172.9 KB42.3 KB215.2 KB0.0 KB/s2.8 KB23:07:54
13news.samoylyk.net123.8 KB4.8 KB128.6 KB0.0 KB/s2.3 KB23:06:24
14weretis.net64.6 KB2.6 KB67.2 KB0.0 KB/s1.9 KB23:06:24
15tnetconsulting.net11.0 KB101.8 KB112.8 KB0.0 KB/s4.5 KB23:09:05
16gijs.erje.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:09:55
TOTAL: 1685.9 MB40.9 MB126.8 MB0.1 KB/s2.8 KB369:56:13
Outgoing feeds (innfeed) by volume

NNRP readership statistics [Top 100]:

SystemConnArtsSizeGroupsPostRejElapsed
1toma-03.stehlik.co.uk 457 00.0 KB 0 0 022:48:16
22a03:cfc0:8000:b::c303:dce8 276 00.0 KB 0 0 000:20:57
32603:6010:6802:4ca5:1a03:73ff:fe28:be0f 4 00.0 KB 0 0 000:00:09
4128.172.132.66.censys-scanner.com 3 00.0 KB 0 0 000:00:12
566.61.98.95 2 00.0 KB 0 0 000:00:05
6194.88.98.103 1 00.0 KB 0 0 000:00:00
75.226.140.74 1 00.0 KB 0 0 000:00:00
891.238.181.92 1 00.0 KB 0 0 000:00:00
9adelaide.probe.onyphe.net 1 00.0 KB 0 0 000:00:03
10kotz.erje.net 1 00.0 KB 0 0 000:00:00
11server-03.e-n-c-r-y-p-t.cc 1 00.0 KB 0 0 000:00:02
12susie.probe.onyphe.net 1 00.0 KB 0 0 000:00:00
TOTAL: 12 749 00.0 KB 0 0 023:09:49

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

SystemConnArtsSizeGroupsPostRejElapsed
1*.stehlik.co.uk 457 00.0 KB 0 0 022:48:16
2unresolved 285 00.0 KB 0 0 000:21:13
3*.66.censys-scanner.com 3 00.0 KB 0 0 000:00:12
4*.probe.onyphe.net 2 00.0 KB 0 0 000:00:04
5*.e-n-c-r-y-p-t.cc 1 00.0 KB 0 0 000:00:02
6*.erje.net 1 00.0 KB 0 0 000:00:00
TOTAL: 6 749 00.0 KB 0 0 023:09:49

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
toma-03.stehlik.co.uk 54.043 30.998 106.16222:48:16
2a03:cfc0:8000:b::c303:dce8 29.836 17.240 0.00000:20:57
128.172.132.66.censys-scanner.com 0.238 0.046 0.00000:00:12
2603:6010:6802:4ca5:1a03:73ff:fe28:be0f 0.291 0.060 0.00000:00:09
66.61.98.95 0.122 0.055 0.00000:00:05
adelaide.probe.onyphe.net 0.062 0.023 0.00000:00:03
server-03.e-n-c-r-y-p-t.cc 0.092 0.084 0.00000:00:02
susie.probe.onyphe.net 0.058 0.022 0.00000:00:00
kotz.erje.net 0.072 0.024 0.00000:00:00
194.88.98.103 0.053 0.009 0.00000:00:00
5.226.140.74 0.079 0.008 0.00000:00:00
91.238.181.92 0.081 0.008 0.00000:00:00
TOTAL: 12 85.027 48.577 106.16223:09:49

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

SystemConn
susie.probe.onyphe.net 2
91.238.181.92 1
TOTAL: 2 3

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

CommandCount
?$?,?r?s?^S^B^S^A?^T?^G?^R?^S?'?/?^T?(?0?`?a... 1
^C 1
^V^C^C^Bd^A 1
TOTAL: 3 3

NNRP client timeouts [Top 20]:

SystemConnPeer
5.226.140.74 1 1
91.238.181.92 1 1
TOTAL: 2 2 5
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