Daily Usenet Report

Apr 12 00:01:02 -- Apr 13 00:01:02

Unknown entries from news log file:

First 2 / 2 lines (100.0%)

Apr 12 08:16:53 newsfeed innd: message repeated 2 times: [ ctlinnd command s]
Apr 13 00:00:01 newsfeed nnrpd[3133017]: localhost auth: program exited with status 8

Log entries by program:

Program nameLines%LinesSize%Size
nnrpd 25141 53.0%3.0 MB 34.9%
innd 8979 18.9%1.3 MB 14.8%
inn 7773 16.4%3.3 MB 38.2%
innfeed 4907 10.3%960.2 KB 11.0%
cnfsstat 576 1.2%88.1 KB 1.0%
nocem 62 0.1%7.8 KB 0.1%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 7 47439 100.0%8.5 MB100.0%

History cache:

ReasonCount%Count
Positive hits 116220 62.7%
Negative hits 61451 33.1%
Do not exist 7685 4.1%
Cache misses 55 0.0%
TOTAL: 4 185411 100.0%

innd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.156 0.0%22 1.500 7.091 19.000
article cleanup00:00:00.106 0.0%7726 0.000 0.014 0.182
article logging00:00:00.372 0.0%7760 0.000 0.048 0.242
article parse00:00:00.234 0.0%15346 0.000 0.015 0.093
article write00:00:01.893 0.0%6021 0.000 0.314 3.614
artlog/artcncl00:00:00.000 0.0%3 0.000 0.000 0.000
artlog/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
data move00:00:00.871 0.0%188051 0.000 0.005 0.340
hisgrep/artcncl00:00:00.129 0.0%25 0.000 5.160 7.800
hishave/artcncl00:00:00.000 0.0%3 0.000 0.000 0.000
hishave/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:02:11.251 0.2%185983 0.096 0.706 6.719
history sync00:00:00.069 0.0%397 0.000 0.174 1.000
history write00:01:47.748 0.1%7704 3.565 13.986 130.923
hiswrite/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
idle23:47:22.938 99.1%191693 69.349 446.771 2136.943
nntp read00:00:06.630 0.0%189181 0.003 0.035 1.924
overview write00:08:00.641 0.6%6021 0.606 79.827 4133.455
perl filter00:00:22.722 0.0%7704 1.247 2.949 22.286
python filter00:00:01.046 0.0%7704 0.000 0.136 3.500
site send00:00:01.076 0.0%12098 0.000 0.089 0.278
TOTAL: 2223:59:57.882 99.9%----

innfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.024 0.0%13645 0.000 0.002 0.083
article prepare00:00:00.011 0.0%45646 0.000 0.000 0.007
article read00:00:00.947 0.0%3900 0.000 0.243 1.201
backlog stats00:00:00.441 0.0%256027 0.000 0.002 0.007
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:02.167 0.0%175466 0.002 0.012 0.044
data write00:00:03.381 0.0%172524 0.008 0.020 0.060
idle23:58:41.307100.0%256027 82.708 337.157 1515.503
status file00:00:00.587 0.0%427 1.000 1.375 15.500
TOTAL: 923:58:48.865100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:52:33.040 99.9%16706 43.000 188.737167781.500
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:04.565 0.1%112313 0.000 0.041 2.000
TOTAL: 300:52:37.605100.0%----

Control commands to innd:

CommandNumber
flush 5
flushlogs 2
go 2
logmode 2
lowmark 1
mode 97
name 2
pause 2
paused 2
reload 2
reserve 2
TOTAL: 11 119

Incoming feeds (innd):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1news.dne3.net 2 6669 1257 5403 9 18%29:31:11
2endofthelinebbs-out.news.weretis.net 3 11653 994 10410 249 8%47:03:17
3usenet.blueworldhosting.com 716 7477 649 6196 632 8%23:56:33
4usenet.goja.nl.eu.org 11 7106 574 6319 213 8%24:22:17
5news.corradoroberto.it 2 1718 458 1260 0 26%24:40:38
6newsfeed.xs3.de 2 4988 419 4488 81 8%23:58:01
7i2pn.org 1 6959 274 6577 108 3%23:59:53
8nntp.comgw.net 2 7272 226 6903 143 3%23:58:20
9newsfeed.bofh.team 2 7636 204 7374 58 2%23:58:33
10endoftheline-out.news.chmurka.net 2 2876 176 2699 1 6%23:58:41
11news.hispagatos.org 5 7378 175 7109 94 2%24:26:21
12usenet.network 1 5238 164 5064 10 3%23:59:58
13194.87.241.33 44 255 127 102 26 49%13:42:38
14news.samoylyk.net 0 5607 125 5481 1 2%24:15:04
15glockenspiel.complete.org 2 4854 106 4745 3 2%23:59:54
16endofthelinebbs.peers.news.panix.com 26 6380 104 6261 15 1%24:03:32
17peering.usenet.ovh 1 6869 100 6765 4 1%23:59:57
18news-out.tcpreset.net 2 5725 85 5633 7 1%23:59:49
19news.netfront.net 2 8066 9 7986 71 0%31:27:03
20outgoing.news.lysator.liu.se 3 4795 9 4784 2 0%27:41:28
21news.furie.org.uk 2 3284 7 3275 2 0%23:57:05
22news.bbs.nz 1 6096 3 6091 2 0%23:59:33
23eotl-out.news.tnetconsulting.net 1 0 0 0 0 0%00:10:04
24localhost 26 0 0 0 0 0%00:00:00
25news.nk.ca 2 0 0 0 0 0%00:20:02
TOTAL: 25 861 128901 6245 120925 1731 4%559:29:52
Articles received by server

Incoming volume (innd):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1endofthelinebbs-out.news.weretis.net12.6 MB8.5 KB684.7 KB13.2 MB 94%10.9 KB
2news.dne3.net3.4 MB6.1 KB5.7 KB3.4 MB 99%2.8 KB
3news.corradoroberto.it2.9 MB0.0 KB0.0 KB2.9 MB100%6.5 KB
4usenet.network1.9 MB2.3 KB14.8 KB1.9 MB 99%11.3 KB
5usenet.goja.nl.eu.org1.5 MB0.0 KB299.6 KB1.8 MB 83%2.4 KB
6usenet.blueworldhosting.com1.4 MB0.0 KB1.1 MB2.6 MB 55%2.1 KB
7newsfeed.xs3.de1.1 MB0.0 KB136.2 KB1.2 MB 88%2.5 KB
8nntp.comgw.net777.6 KB0.0 KB354.7 KB1.1 MB 68%3.1 KB
9glockenspiel.complete.org776.3 KB6.1 KB0.6 KB783.1 KB 99%7.2 KB
10endofthelinebbs.peers.news.panix.com774.4 KB6.2 KB31.9 KB812.5 KB 95%6.8 KB
11newsfeed.bofh.team744.3 KB0.0 KB94.6 KB838.9 KB 88%3.2 KB
12news.samoylyk.net689.6 KB0.0 KB6.3 KB695.9 KB 99%5.5 KB
13endoftheline-out.news.chmurka.net667.3 KB0.0 KB0.7 KB668.0 KB 99%3.8 KB
14news.hispagatos.org646.6 KB0.0 KB150.8 KB797.5 KB 81%3.0 KB
15i2pn.org645.8 KB6.1 KB138.2 KB790.2 KB 81%2.1 KB
16peering.usenet.ovh329.7 KB0.0 KB4.9 KB334.6 KB 98%3.2 KB
17194.87.241.33322.8 KB767.7 KB33.1 KB1.1 MB 28%7.3 KB
18news-out.tcpreset.net202.3 KB6.2 KB5.8 KB214.3 KB 94%2.3 KB
19outgoing.news.lysator.liu.se31.5 KB6.1 KB0.0 KB37.7 KB 83%3.4 KB
20news.furie.org.uk30.8 KB2.3 KB0.7 KB33.8 KB 91%3.8 KB
21news.netfront.net28.5 KB6.3 KB3.3 MB3.3 MB 0%42.3 KB
22news.bbs.nz4.0 KB6.2 KB0.0 KB10.2 KB 39%2.0 KB
23eotl-out.news.tnetconsulting.net0.0 KB0.0 KB0.0 KB0.0 KB 0%0
24localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
25news.nk.ca0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 2531.3 MB830.1 KB6.3 MB38.5 MB 81%4.9 KB
Incoming volume received by server

Incoming articles (innd):

DateArticles%ArtsArt/secSize%SizeKB/sec
Apr 12 00:01:02 - 00:59:59 166 2.8% 0.05772.9 KB 2.3% 0.22
Apr 12 01:00:00 - 01:59:59 244 4.0% 0.07778.0 KB 2.3% 0.22
Apr 12 02:00:00 - 02:59:59 266 4.4% 0.07787.4 KB 2.3% 0.22
Apr 12 03:00:00 - 03:59:59 316 5.2% 0.091014.7 KB 3.0% 0.28
Apr 12 04:00:00 - 04:59:59 418 6.9% 0.121.1 MB 3.2% 0.31
Apr 12 05:00:00 - 05:59:59 381 6.3% 0.11995.6 KB 2.9% 0.28
Apr 12 06:00:00 - 06:59:59 280 4.6% 0.08748.5 KB 2.2% 0.21
Apr 12 07:00:00 - 07:59:59 299 5.0% 0.08937.9 KB 2.7% 0.26
Apr 12 08:00:00 - 08:59:59 329 5.5% 0.091.0 MB 3.1% 0.29
Apr 12 09:00:00 - 09:59:59 431 7.1% 0.1214.0 MB 42.0% 3.99
Apr 12 10:00:00 - 10:59:59 274 4.5% 0.081.6 MB 4.8% 0.46
Apr 12 11:00:00 - 11:59:59 302 5.0% 0.081.4 MB 4.2% 0.39
Apr 12 12:00:00 - 12:59:59 271 4.5% 0.08775.6 KB 2.3% 0.22
Apr 12 13:00:00 - 13:59:59 311 5.2% 0.091.1 MB 3.4% 0.32
Apr 12 14:00:00 - 14:59:59 284 4.7% 0.08788.4 KB 2.3% 0.22
Apr 12 15:00:00 - 15:59:59 285 4.7% 0.08996.5 KB 2.9% 0.28
Apr 12 16:00:00 - 16:59:59 295 4.9% 0.081.4 MB 4.3% 0.41
Apr 12 17:00:00 - 17:59:59 186 3.1% 0.05781.5 KB 2.3% 0.22
Apr 12 18:00:00 - 18:59:59 183 3.0% 0.05667.2 KB 2.0% 0.19
Apr 12 19:00:00 - 19:59:59 124 2.1% 0.03509.4 KB 1.5% 0.14
Apr 12 20:00:00 - 20:59:59 84 1.4% 0.02298.7 KB 0.9% 0.08
Apr 12 21:00:00 - 21:59:59 116 1.9% 0.03492.3 KB 1.4% 0.14
Apr 12 22:00:00 - 22:59:59 95 1.6% 0.03329.0 KB 1.0% 0.09
Apr 12 23:00:00 - 23:59:59 77 1.3% 0.02270.1 KB 0.8% 0.08
Apr 13 00:00:00 - 00:01:02 16 0.3% 0.2643.7 KB 0.1% 0.70
TOTAL: 24:00:00 6033 100.0% 0.0733.4 MB 100.0% 0.40
Incoming articles
Incoming articles (size)

CNFS buffer status:

BufferClassSizeUsed%UsedCyclesKB/secDays
CYCNGS1NGS1536.0 GB48.0 MB 0.0% 1 0.00 0.00
CYCNGS2NGS1536.0 GB106.2 GB 6.9% 0 0.4046584.96
CYCNGS3NGS1536.0 GB48.0 MB 0.0% 0 0.00 0.00
CYCTXT1TEXT5.0 GB4.2 GB 84.0% 0 0.53 114.28
TOTAL: 4-4613.0 GB110.4 GB 2.4% 1 0.43-

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1usenet.blueworldhosting.com 640 0 0 0 0 0 0 0 640
2endofthelinebbs-out.news.weretis.net 253 0 0 3 0 0 0 0 250
3usenet.goja.nl.eu.org 182 0 0 0 0 0 0 0 182
4nntp.comgw.net 154 0 0 0 0 0 0 0 154
5i2pn.org 109 0 0 2 0 0 0 0 107
6news.hispagatos.org 107 0 0 0 0 0 0 0 107
7newsfeed.xs3.de 82 0 0 0 0 0 0 0 82
8news.netfront.net 63 0 0 2 0 0 0 0 61
9newsfeed.bofh.team 63 1 0 0 0 0 0 0 62
10194.87.241.33 26 0 0 1 0 0 0 0 25
11endofthelinebbs.peers.news.panix.com 16 2 0 2 0 0 0 0 12
12usenet.network 10 0 0 1 0 0 0 0 9
13news-out.tcpreset.net 9 0 0 2 0 0 0 0 7
14news.dne3.net 8 0 0 2 0 0 0 0 6
15glockenspiel.complete.org 4 0 0 2 0 0 0 0 2
16peering.usenet.ovh 4 0 0 0 0 0 0 0 4
17news.bbs.nz 2 0 0 2 0 0 0 0 0
18news.furie.org.uk 2 0 0 1 0 0 0 0 1
19outgoing.news.lysator.liu.se 2 0 0 2 0 0 0 0 0
20endoftheline-out.news.chmurka.net 1 0 0 0 0 0 0 0 1
TOTAL: 20 1737 3 0 22 0 0 0 0 1712

Unwanted newsgroups [Top 20]:

NewsgroupCount
misc.phone.mobile.android 2
saar.ip.sex 1
TOTAL: 2 3

Perl filter (innd) [Top 20]:

ReasonCount
EMP (phn path) 889
EMP (phr path) 288
Too many newsgroups 272
Too many newsgroups (meow) 83
EMP (md5) 77
Binary: misplaced binary 40
Angle-bracket bot 15
HTML Multipart 8
User-issued cancel 6
TOTAL: 9 1678

NoCeM on spool:

Issuer (type)NoticesBad PGPCancelSkipTotal
robot@pasdenom.info (spam3)5004040
robot@pasdenom.info (spam2)27002929
i2pn2-nocem@i2pn2.org (multipost)21002424
robot@pasdenom.info (spam4)6001313
i2pn2-nocem@i2pn2.org (rmp)20077
TOTAL: 56100113113

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
usenet.blueworldhosting.com 8
endofthelinebbs-out.news.weretis.net 7
nntp.comgw.net 6
newsfeed.bofh.team 5
i2pn.org 3
glockenspiel.complete.org 2
usenet.goja.nl.eu.org 1
newsfeed.xs3.de 1
endofthelinebbs.peers.news.panix.com 1
TOTAL: 9 34
TOTAL: 1 34

Outgoing feeds (innfeed) by articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1nyheter.lysator.liu.se 6657 1935 3923 161 0 0 29%23:59:03
2news.netfront.net 9689 1750 4256 8 0 72 18%23:59:53
3news.furie.org.uk 3762 854 2126 17 0 0 22%23:59:53
4photonic.trudheim.com 6718 465 4216 1342 0 0 6%23:59:21
5news.dne3.net 5060 392 4445 96 0 0 7%23:59:53
6endofthelinebbs.peers.news.panix.com 6267 352 5620 6 0 0 5%23:59:53
7peering.usenet.ovh 6574 332 5551 43 0 0 5%23:59:53
8usenet.goja.nl.eu.org 6544 314 5079 6 0 0 4%23:59:18
9news.nntp4.net 6641 309 5551 1 0 46 4%23:58:58
10news.tcpreset.net 7050 117 5003 712 0 1 1%23:59:53
11news.hispagatos.org 7251 88 5720 28 0 27 1%23:59:53
12newsfeed.bofh.team 6960 78 5736 0 0 31 1%23:59:53
13nntp.comgw.net 6369 76 5710 5 0 33 1%23:59:53
14news.bbs.nz 11201 57 5493 467 0 209 0%23:59:32
15i2pn.org 6598 54 5558 46 0 148 0%23:59:44
16usenet.network 7020 51 5390 10 0 0 0%23:59:53
17news.weretis.net 6436 26 5889 108 0 36 0%23:59:22
18news.nk.ca 11717 25 9741 491 0 2462 0%23:59:53
19news.quux.org 6104 25 5417 358 0 0 0%23:59:51
20news.samoylyk.net 6938 22 5477 22 0 385 0%23:59:53
21news.chmurka.net 3698 20 2564 9 0 19 0%23:59:53
22usenet.blueworldhosting.com 5701 17 5095 0 0 0 0%23:58:33
23news.tnetconsulting.net 8723 15 5827 135 0 119 0%23:58:37
24ddt.demos.su 57 15 38 0 0 0 26%06:33:03
25newsfeed.xs3.de 7219 14 5403 175 0 42 0%23:59:53
26news.corradoroberto.it 588 1 421 0 0 2 0%21:13:12
27feed.opticnetworks.net 0 0 0 0 0 6028 0%23:59:53
TOTAL: 27 167542 7404 125249 4246 0 9660 4%627:36:49
Outgoing feeds (innfeed) by articles

Outgoing feeds (innfeed) by volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.netfront.net17.0 MB45.8 KB17.0 MB0.2 KB/s9.9 KB23:59:53
2news.furie.org.uk16.0 MB137.7 KB16.1 MB0.2 KB/s19.0 KB23:59:53
3nyheter.lysator.liu.se11.8 MB1.2 MB13.0 MB0.2 KB/s6.4 KB23:59:03
4peering.usenet.ovh2.3 MB151.2 KB2.5 MB0.0 KB/s6.8 KB23:59:53
5photonic.trudheim.com1.6 MB10.1 MB11.8 MB0.1 KB/s6.7 KB23:59:21
6endofthelinebbs.peers.news.panix.com1.5 MB18.2 KB1.5 MB0.0 KB/s4.3 KB23:59:53
7news.bbs.nz1.2 MB2.1 MB3.2 MB0.0 KB/s6.3 KB23:59:32
8news.nntp4.net1.1 MB1.9 KB1.1 MB0.0 KB/s3.6 KB23:58:58
9news.dne3.net1.1 MB1.4 MB2.5 MB0.0 KB/s5.2 KB23:59:53
10news.samoylyk.net972.6 KB27.6 KB1000.2 KB0.0 KB/s22.7 KB23:59:53
11usenet.goja.nl.eu.org858.5 KB44.4 KB902.9 KB0.0 KB/s2.8 KB23:59:18
12news.quux.org804.8 KB1.1 MB1.9 MB0.0 KB/s5.0 KB23:59:51
13news.hispagatos.org550.8 KB96.8 KB647.6 KB0.0 KB/s5.6 KB23:59:53
14newsfeed.bofh.team328.6 KB0.0 KB328.6 KB0.0 KB/s4.2 KB23:59:53
15i2pn.org227.5 KB674.7 KB902.2 KB0.0 KB/s9.0 KB23:59:44
16nntp.comgw.net219.3 KB782.7 KB1001.9 KB0.0 KB/s12.4 KB23:59:53
17news.tcpreset.net214.6 KB2.0 MB2.2 MB0.0 KB/s2.8 KB23:59:53
18usenet.network95.6 KB53.6 KB149.1 KB0.0 KB/s2.4 KB23:59:53
19news.weretis.net63.1 KB1.5 MB1.6 MB0.0 KB/s11.9 KB23:59:22
20ddt.demos.su54.9 KB0.0 KB54.9 KB0.0 KB/s3.7 KB06:33:03
21news.chmurka.net50.2 KB952.8 KB1003.0 KB0.0 KB/s34.6 KB23:59:53
22news.nk.ca49.0 KB4.1 MB4.2 MB0.0 KB/s8.3 KB23:59:53
23newsfeed.xs3.de26.7 KB435.0 KB461.6 KB0.0 KB/s2.4 KB23:59:53
24news.tnetconsulting.net23.9 KB799.2 KB823.1 KB0.0 KB/s5.5 KB23:58:37
25usenet.blueworldhosting.com19.0 KB0.0 KB19.0 KB0.0 KB/s1.1 KB23:58:33
26news.corradoroberto.it1.2 KB0.0 KB1.2 KB0.0 KB/s1.2 KB21:13:12
27feed.opticnetworks.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:53
TOTAL: 2758.1 MB27.6 MB85.7 MB0.0 KB/s7.5 KB627:36:49
Outgoing feeds (innfeed) by volume

NNRP readership statistics [Top 100]:

SystemConnArtsSizeGroupsPostRejElapsed
1news.nntp4.net2785 00.0 KB 0 0 000:21:28
22a0e:73c2:8000:802c::22784 00.0 KB 0 0 000:19:28
3167.94.146.58 3 00.0 KB 0 0 000:00:04
4206.168.34.120 3 00.0 KB 0 0 000:00:12
5147.185.132.13 1 00.0 KB 0 0 000:00:03
6198.235.24.65 1 00.0 KB 0 0 000:00:02
720.83.156.52 1 00.0 KB 0 0 000:00:00
82607:ff10:c8:594::4 1 00.0 KB 0 0 000:00:00
991.238.181.94 1 00.0 KB 0 0 000:00:00
10localhost 1 00.0 KB 0 0 000:11:15
11zl-dala-us-gr1-wk104a.internet-census.org 1 00.0 KB 0 0 000:00:00
TOTAL: 115582 00.0 KB 0 0 000:52:35

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

SystemConnArtsSizeGroupsPostRejElapsed
1unresolved2795 00.0 KB 0 0 000:19:51
2*.nntp4.net2785 00.0 KB 0 0 000:21:28
3*.internet-census.org 1 00.0 KB 0 0 000:00:00
4*localhost 1 00.0 KB 0 0 000:11:15
TOTAL: 45582 00.0 KB 0 0 000:52:35

NNRP auth users [Top 20]:

UserConn
getlist 1
TOTAL: 1 1

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
news.nntp4.net 10.503 29.358 0.00000:21:28
2a0e:73c2:8000:802c::2 10.144 29.476 0.00000:19:28
localhost 184.033 371.516 0.07700:11:15
206.168.34.120 0.030 0.026 0.00000:00:12
167.94.146.58 0.027 0.025 0.00000:00:04
147.185.132.13 0.000 0.013 0.00000:00:03
198.235.24.65 0.000 0.013 0.00000:00:02
2607:ff10:c8:594::4 0.003 0.010 0.00000:00:00
zl-dala-us-gr1-wk104a.internet-census.org 0.005 0.009 0.00000:00:00
91.238.181.94 0.000 0.013 0.00000:00:00
20.83.156.52 0.000 0.013 0.00000:00:00
TOTAL: 11 204.745 430.472 0.07700:52:35

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

SystemConn
167.94.146.58 1
20.83.156.52 1
206.168.34.120 1
91.238.181.94 1
TOTAL: 4 4

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

CommandCount
EHLO www.censys.io 2
#003 1
MGLNDD_144.172.126.95_119 1
TOTAL: 3 4

NNRP client timeouts [Top 20]:

SystemConnPeer
167.94.146.58 1 2
206.168.34.120 1 2
91.238.181.94 1 1
TOTAL: 3 3 8