Daily Usenet report

Aug 1 00:01:01 -- Aug 2 00:01:02

Unknown entries from news log file:

First 1 / 1 lines (100.0%)

Aug 1 00:34:28 www innd: message repeated 2 times: [ ctlinnd command s]

Log entries by program:

Program nameLines%LinesSize%Size
inn 102129 78.3%16.4 MB 82.5%
innd 24428 18.7%2.8 MB 13.9%
innfeed 3755 2.9%710.9 KB 3.5%
nnrpd 88 0.1%7.7 KB 0.0%
controlchan 12 0.0%2.8 KB 0.0%
TOTAL: 5 130412 100.0%19.9 MB100.0%

History cache:

ReasonCount%Count
Negative hits 204977 40.7%
Positive hits 196868 39.1%
Do not exist 100613 20.0%
Cache misses 1157 0.2%
TOTAL: 4 503615 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.167 0.0%33 0.250 5.061 19.000
article cleanup00:00:02.178 0.0%101858 0.000 0.021 0.103
article logging00:00:05.974 0.0%102139 0.000 0.058 0.115
article parse00:00:14.851 0.0%860102 0.000 0.017 0.037
article write00:00:27.872 0.0%16955 0.505 1.644 5.867
artlog/artcncl00:00:00.001 0.0%6 0.000 0.167 0.500
artlog/artparse00:00:00.000 0.0%2 0.000 0.000 0.000
data move00:00:02.850 0.0%1169982 0.000 0.002 0.009
hisgrep/artcncl00:00:00.040 0.0%39 0.000 1.026 3.000
hishave/artcncl00:00:00.000 0.0%6 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:00:47.772 0.1%504762 0.012 0.095 0.371
history sync00:00:00.058 0.0%340 0.000 0.171 1.500
history write00:01:00.817 0.1%100812 0.388 0.603 2.286
hiswrite/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
idle23:50:29.486 99.3%1165828 11.160 73.621 668.446
nntp read00:01:57.941 0.1%1194055 0.019 0.099 0.274
overview write00:00:31.754 0.0%16955 0.290 1.873 10.633
perl filter00:01:14.304 0.1%36108 1.224 2.058 4.725
python filter00:00:05.229 0.0%36108 0.075 0.145 0.375
site send00:00:08.767 0.0%33911 0.045 0.259 0.696
TOTAL: 24:00:40.08523:57:10.061 99.8%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.179 0.0%20207 0.000 0.009 0.196
article prepare00:00:00.035 0.0%188088 0.000 0.000 0.003
article read00:00:05.723 0.0%17002 0.120 0.337 1.444
backlog stats00:00:01.336 0.0%547341 0.000 0.002 0.006
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:12.737 0.0%410339 0.015 0.031 0.045
data write00:00:54.683 0.1%380308 0.116 0.144 0.455
idle23:53:18.304 99.9%547341 16.371 157.120 641.818
status file00:00:00.375 0.0%338 0.000 1.109 4.000
TOTAL: 23:54:58.60323:54:33.372100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle01:48:14.022100.0%265 21.000 24505.743 24970.850
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.066 0.0%652 0.098 0.101 0.500
readart00:00:00.251 0.0%619 0.405 0.405 0.405
TOTAL: 01:48:16.10601:48:14.339100.0%----

Control commands to INND:

CommandNumber
flush 4
flushlogs 2
go 2
logmode 2
lowmark 1
mode 143
name 2
pause 2
paused 2
reload 2
reserve 2
TOTAL: 11 164

Control Channel:

SendernewgrouprmgroupOtherBad PGPDoItOK
moderator@dana.de001011
TOTAL001011

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1endofthelinebbs-out.news.weretis.net 5 26130 5244 20159 727 20%48:27:04
2news.samoylyk.net 9 79901 4204 10849 64848 5%22:39:27
3usenet.blueworldhosting.com 288 15588 3909 11006 673 25%23:44:42
4usenet.goja.nl.eu.org 11 14802 792 13832 178 5%23:34:38
5outgoing.news.lysator.liu.se 5 26711 696 14637 11378 2%27:39:57
6usenet.network 2 11911 500 10538 873 4%23:59:55
7endoftheline-out.news.chmurka.net 2 5411 363 5046 2 6%23:59:34
8newsfeed.xs3.de 1 11642 244 11397 1 2%23:59:55
9endofthelinebbs.peers.news.panix.com 25 12893 215 12661 17 1%23:58:19
10paganini.bofh.team 2 15277 163 15049 65 1%23:58:44
11i2pn.org 1 13798 162 13613 23 1%23:59:54
12194.87.241.33 31 637 145 70 422 22%20:13:32
13nntp.alphanet.ch 25 10256 104 10134 18 1%23:57:06
14glockenspiel.complete.org 2 11372 64 11302 6 0%23:59:43
15news.nntp4.net 8 12783 48 12732 3 0%25:46:58
16news.bbs.nz 2 12070 10 12060 0 0%23:59:37
17news.furie.org.uk 1 6653 2 6651 0 0%23:59:56
18news.netfront.net 21 8369 0 2884 5485 0%20:01:02
19localhost 25 0 0 0 0 0%00:00:00
20eotl-out.news.tnetconsulting.net 1 0 0 0 0 0%00:10:13
21news.nk.ca 2 0 0 0 0 0%00:20:01
TOTAL: 21 469 296204 16865 194620 84719 5%452:30:17
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1usenet.blueworldhosting.com27.4 MB0.0 KB3.6 MB30.9 MB 88%6.9 KB
2endofthelinebbs-out.news.weretis.net23.6 MB103.7 KB1.1 MB24.8 MB 95%4.2 KB
3news.samoylyk.net12.7 MB1.3 MB196.3 MB210.3 MB 6%3.1 KB
4usenet.network4.0 MB27.3 KB1.8 MB5.9 MB 68%4.4 KB
5usenet.goja.nl.eu.org3.2 MB3.8 KB392.3 KB3.6 MB 89%3.8 KB
6nntp.alphanet.ch2.0 MB0.0 KB81.5 KB2.1 MB 96%17.2 KB
7outgoing.news.lysator.liu.se1.8 MB92.5 MB3.8 GB3.9 GB 0%334.8 KB
8endoftheline-out.news.chmurka.net1.2 MB0.0 KB17.7 KB1.3 MB 98%3.5 KB
9newsfeed.xs3.de963.6 KB0.0 KB1.3 KB964.8 KB 99%3.9 KB
10endofthelinebbs.peers.news.panix.com905.1 KB0.0 KB43.0 KB948.1 KB 95%4.1 KB
11paganini.bofh.team755.8 KB0.0 KB264.5 KB1020.2 KB 74%4.5 KB
12i2pn.org653.4 KB599.6 KB47.0 KB1.3 MB 50%7.0 KB
13194.87.241.33504.0 KB54.3 KB954.1 KB1.5 MB 33%2.7 KB
14glockenspiel.complete.org351.7 KB0.0 KB53.9 KB405.6 KB 86%5.8 KB
15news.nntp4.net163.0 KB0.0 KB3.9 KB166.8 KB 97%3.3 KB
16news.bbs.nz22.5 KB0.0 KB0.0 KB22.5 KB100%2.2 KB
17news.furie.org.uk9.9 KB0.0 KB0.0 KB9.9 KB100%5.0 KB
18news.netfront.net0.0 KB232.8 MB1.8 GB2.0 GB 0%380.8 KB
19localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
20eotl-out.news.tnetconsulting.net0.0 KB0.0 KB0.0 KB0.0 KB 0%0
21news.nk.ca0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 2180.2 MB327.4 MB5.7 GB6.1 GB 1%63.2 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Aug 1 00:01:01 - 00:59:59 2679 15.8% 0.768.9 MB 11.1% 2.58
Aug 1 01:00:00 - 01:59:59 2194 12.9% 0.618.0 MB 10.0% 2.29
Aug 1 02:00:00 - 02:59:59 383 2.3% 0.112.3 MB 2.9% 0.66
Aug 1 03:00:00 - 03:59:59 537 3.2% 0.153.5 MB 4.3% 0.99
Aug 1 04:00:00 - 04:59:59 601 3.5% 0.172.2 MB 2.7% 0.61
Aug 1 05:00:00 - 05:59:59 668 3.9% 0.192.9 MB 3.6% 0.83
Aug 1 06:00:00 - 06:59:59 572 3.4% 0.161.9 MB 2.3% 0.53
Aug 1 07:00:00 - 07:59:59 664 3.9% 0.182.9 MB 3.6% 0.83
Aug 1 08:00:00 - 08:59:59 724 4.3% 0.204.3 MB 5.3% 1.21
Aug 1 09:00:00 - 09:59:59 637 3.8% 0.182.7 MB 3.4% 0.77
Aug 1 10:00:00 - 10:59:59 665 3.9% 0.183.4 MB 4.2% 0.96
Aug 1 11:00:00 - 11:59:59 762 4.5% 0.213.5 MB 4.3% 0.98
Aug 1 12:00:00 - 12:59:59 746 4.4% 0.214.3 MB 5.4% 1.24
Aug 1 13:00:00 - 13:59:59 691 4.1% 0.193.1 MB 3.8% 0.87
Aug 1 14:00:00 - 14:59:59 644 3.8% 0.183.0 MB 3.7% 0.84
Aug 1 15:00:00 - 15:59:59 540 3.2% 0.151.9 MB 2.3% 0.53
Aug 1 16:00:00 - 16:59:59 516 3.0% 0.143.0 MB 3.8% 0.86
Aug 1 17:00:00 - 17:59:59 546 3.2% 0.154.4 MB 5.4% 1.24
Aug 1 18:00:00 - 18:59:59 341 2.0% 0.091.7 MB 2.1% 0.47
Aug 1 19:00:00 - 19:59:59 353 2.1% 0.101.9 MB 2.3% 0.53
Aug 1 20:00:00 - 20:59:59 357 2.1% 0.102.5 MB 3.2% 0.73
Aug 1 21:00:00 - 21:59:59 340 2.0% 0.093.5 MB 4.4% 1.00
Aug 1 22:00:00 - 22:59:59 436 2.6% 0.122.9 MB 3.6% 0.82
Aug 1 23:00:00 - 23:59:59 342 2.0% 0.101.9 MB 2.3% 0.54
Aug 2 00:00:00 - 00:01:02 11 0.1% 0.1853.5 KB 0.1% 0.86
TOTAL: 24:00:01 16949 100.0% 0.2080.5 MB 100.0% 0.95
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1news.samoylyk.net 64858 0 0 142 0 64702 0 0 14
2outgoing.news.lysator.liu.se 11366 0 0 244 0 0 0 011122
3news.netfront.net 5616 0 0 614 0 0 0 0 5002
4endofthelinebbs-out.news.weretis.net 944 0 0 39 0 0 0 0 905
5usenet.network 897 43 0 2 0 0 0 0 852
6usenet.blueworldhosting.com 678 3 0 0 0 0 0 0 675
7194.87.241.33 422 176 0 4 0 0 0 0 242
8usenet.goja.nl.eu.org 180 0 0 2 0 0 0 0 178
9glockenspiel.complete.org 78 0 0 0 0 0 0 0 78
10paganini.bofh.team 68 0 0 0 0 0 0 0 68
11i2pn.org 24 0 0 1 0 0 0 0 23
12endofthelinebbs.peers.news.panix.com 19 7 0 0 0 0 0 0 12
13nntp.alphanet.ch 16 0 0 0 0 0 0 0 16
14endoftheline-out.news.chmurka.net 4 0 0 0 0 0 0 0 4
15news.nntp4.net 3 0 0 0 0 0 0 0 3
16newsfeed.xs3.de 1 0 0 0 0 0 0 0 1
TOTAL: 16 85174 229 0 1048 0 64702 0 019195

Unwanted newsgroups [Top 20]:

NewsgroupCount
fido7.pushkin.local 109
fido7.ukrnews 27
odessa.news 27
perl.cpan 16
fido7.starper.limited 15
fido7.lorapvt.horo 12
fido7.f715.techinfo 6
fido7.downgrade.talks 5
fido7.crimea.robots 3
fido7.fidonet.online 2
fido7.odessa.news 2
ciaoltopmail.com 1
fido7.crimea.business 1
alt.personals.sex 1
fido7.f4441.robots 1
fido7.nodex.tech 1
TOTAL: 16 229

INND Perl filter [Top 20]:

ReasonCount
Too many newsgroups 14924
EMP (phn path) 1822
Binary: misplaced binary 957
EMP (md5) 667
EMP (phr path) 324
EMP (phn nph) 145
EMP (phr nph) 28
EMP (phl) 22
User-issued cancel 16
Too many newsgroups (meow) 4
Subject (Sex dating sites) 1
HTML post 1
HTML Multipart 1
TOTAL: 13 18912

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
endofthelinebbs-out.news.weretis.net 248
usenet.goja.nl.eu.org 11
news.samoylyk.net 10
usenet.blueworldhosting.com 5
outgoing.news.lysator.liu.se 2
endofthelinebbs.peers.news.panix.com 2
endoftheline-out.news.chmurka.net 1
paganini.bofh.team 1
usenet.network 1
TOTAL: 9 281
No colon-space in header field
usenet.blueworldhosting.com 2
TOTAL: 1 2
TOTAL: 2 283

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.netfront.net 16958 12753 18 4177 0 0 75%23:59:51
2ddt.demos.su 4612 4327 265 18 0 0 93%18:54:38
3nyheter.lysator.liu.se 17118 3363 12320 569 0 12 19%23:59:37
4endofthelinebbs.peers.news.panix.com 17133 338 12442 4162 0 0 1%23:59:51
5paganini.bofh.team 20151 335 16544 58 0 113 1%23:59:44
6usenet.blueworldhosting.com 15839 185 12253 79 0 593 1%23:59:20
7news.chmurka.net 7197 161 5102 12 0 0 2%23:59:39
8news.nk.ca 22013 138 12235 4452 0 75 0%23:59:51
9news.furie.org.uk 9610 63 6523 48 0 45 0%23:59:51
10news.bbs.nz 30622 53 16251 627 0 176 0%23:59:51
11news.tnetconsulting.net 19858 36 16109 788 0 93 0%23:59:51
12news.quux.org 19994 35 16551 324 0 477 0%23:59:16
13usenet.network 19677 31 11749 4152 0 1 0%23:59:51
14i2pn.org 19634 30 16360 211 0 528 0%23:59:48
15alphanet.ch 20891 22 16546 267 0 1 0%23:59:51
16news.weretis.net 17127 19 12563 4358 0 0 0%23:59:47
17news.nntp4.net 20064 13 16537 195 0 71 0%23:53:52
18usenet.goja.nl.eu.org 19368 10 15908 223 0 15 0%23:59:51
19news.samoylyk.net 15870 9 12559 177 0 1086 0%23:59:51
20newsfeed.xs3.de 20235 5 16460 224 0 1 0%23:59:51
TOTAL: 20 353971 21926 245295 25121 0 3287 6%474:44:02
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.netfront.net67.3 MB13.1 MB80.5 MB1.0 KB/s4.9 KB23:59:51
2nyheter.lysator.liu.se24.3 MB3.2 MB27.6 MB0.3 KB/s7.2 KB23:59:37
3ddt.demos.su12.7 MB116.4 KB12.8 MB0.2 KB/s3.0 KB18:54:38
4paganini.bofh.team1.7 MB226.8 KB1.9 MB0.0 KB/s4.9 KB23:59:44
5news.furie.org.uk834.9 KB397.4 KB1.2 MB0.0 KB/s11.1 KB23:59:51
6endofthelinebbs.peers.news.panix.com829.4 KB12.5 MB13.3 MB0.2 KB/s3.0 KB23:59:51
7news.quux.org662.6 KB1.1 MB1.8 MB0.0 KB/s5.1 KB23:59:16
8news.samoylyk.net558.0 KB317.4 KB875.4 KB0.0 KB/s4.7 KB23:59:51
9news.chmurka.net539.9 KB46.4 KB586.3 KB0.0 KB/s3.4 KB23:59:39
10news.nk.ca523.8 KB14.8 MB15.3 MB0.2 KB/s3.4 KB23:59:51
11usenet.blueworldhosting.com324.5 KB211.9 KB536.5 KB0.0 KB/s2.0 KB23:59:20
12news.nntp4.net231.5 KB343.4 KB574.9 KB0.0 KB/s2.8 KB23:53:52
13news.bbs.nz225.2 KB2.8 MB3.1 MB0.0 KB/s4.6 KB23:59:51
14usenet.network172.4 KB12.2 MB12.3 MB0.1 KB/s3.0 KB23:59:51
15news.tnetconsulting.net138.9 KB2.2 MB2.3 MB0.0 KB/s2.9 KB23:59:51
16alphanet.ch123.2 KB1.3 MB1.4 MB0.0 KB/s5.1 KB23:59:51
17i2pn.org122.6 KB564.7 KB687.3 KB0.0 KB/s2.9 KB23:59:48
18news.weretis.net73.9 KB14.0 MB14.1 MB0.2 KB/s3.3 KB23:59:47
19usenet.goja.nl.eu.org52.9 KB675.6 KB728.5 KB0.0 KB/s3.1 KB23:59:51
20newsfeed.xs3.de44.8 KB1.1 MB1.2 MB0.0 KB/s5.3 KB23:59:51
TOTAL: 20111.4 MB81.2 MB192.6 MB0.1 KB/s4.2 KB474:44:02
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
147.186.47.220 1 2865.6 KB 5 0 001:48:13
TOTAL: 1 1 2865.6 KB 5 0 001:48:16

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1unresolved 2 2865.6 KB 5 0 001:48:13
2*.ch1.censys-scanner.com 1 00.0 KB 0 0 000:00:00
3*.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:01
TOTAL: 3 4 2865.6 KB 5 0 001:48:16

NNRP auth users [Top 20]:

UserConn
nelgin 1
TOTAL: 1 1

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
47.186.47.220 0.200 0.349 0.00601:48:13
harmonious.monitoring.internet-measurement.com 0.105 0.051 0.00000:00:01
198.199.117.135 0.085 0.055 0.00000:00:00
scanner-26.ch1.censys-scanner.com 0.095 0.050 0.00000:00:00
TOTAL: 4 0.485 0.505 0.00601:48:16

Curious NNRP server explorers [Top 20]:

SystemConn
harmonious.monitoring.internet-measurement.com 1
198.199.117.135 1
scanner-26.ch1.censys-scanner.com 1
TOTAL: 3 3

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

SystemConn
scanner-26.ch1.censys-scanner.com 1
198.199.117.135 1
TOTAL: 2 2

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

CommandCount
EHLO www.censys.io 1
MGLNDD_192.138.210.162_119 1
TOTAL: 2 2

Newsgroup request counts (by hierarchy):

HierarchyCountPct
1news 24 85.7%
2comp 3 10.7%
3soc 1 3.6%
TOTAL: 3 28100.0%

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

NewsgroupCount
1news.admin.peering 17
2news.software.nntp 7
3comp.sys.acorn.networking 3
4soc.genealogy.britain 1
TOTAL: 4 28