Daily Usenet Report

Jan 4 00:01:01 -- Jan 5 00:01:02

Unknown entries from news log file:

First 1 / 1 lines (100.0%)

Jan 4 00:06:51 www innd: message repeated 2 times: [ ctlinnd command s]

Log entries by program:

Program nameLines%LinesSize%Size
inn 15059 66.1%3.9 MB 76.6%
innd 5365 23.6%770.5 KB 14.9%
innfeed 2335 10.3%438.8 KB 8.5%
nnrpd 14 0.1%1.6 KB 0.0%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 5 22774 100.0%5.0 MB100.0%

History cache:

ReasonCount%Count
Positive hits 94919 55.4%
Negative hits 61786 36.0%
Do not exist 14721 8.6%
Cache misses 29 0.0%
TOTAL: 4 171455 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.094 0.0%57 0.000 1.649 6.000
article cleanup00:00:00.263 0.0%14751 0.000 0.018 0.080
article logging00:00:00.639 0.0%14994 0.000 0.043 0.116
article parse00:00:02.187 0.0%128122 0.000 0.017 0.097
article write00:00:13.706 0.0%11545 0.615 1.187 3.486
artlog/artcncl00:00:00.001 0.0%57 0.000 0.018 1.000
artlog/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
data move00:00:00.489 0.0%282567 0.000 0.002 0.013
hisgrep/artcncl00:00:00.015 0.0%56 0.000 0.268 1.333
hishave/artcncl00:00:00.005 0.0%57 0.000 0.088 1.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:08.370 0.0%171870 0.002 0.049 0.138
history sync00:00:00.051 0.0%400 0.000 0.128 1.000
history write00:00:08.857 0.0%14749 0.133 0.601 0.981
hiswrite/artcncl00:00:00.000 0.0%1 0.000 0.000 0.000
hiswrite/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
idle23:57:55.198 99.8%272531 34.176 316.570 1761.202
nntp read00:00:21.375 0.0%273694 0.025 0.078 0.165
overview write00:00:08.154 0.0%11545 0.243 0.706 4.235
perl filter00:00:43.722 0.1%14749 2.272 2.964 6.100
python filter00:00:02.541 0.0%14749 0.077 0.172 0.407
site send00:00:04.786 0.0%23090 0.043 0.207 0.930
TOTAL: 24:01:07.11423:59:50.453 99.9%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.169 0.0%11723 0.000 0.014 0.259
article prepare00:00:00.006 0.0%31416 0.000 0.000 0.008
article read00:00:01.284 0.0%5155 0.000 0.249 2.409
backlog stats00:00:00.538 0.0%248845 0.000 0.002 0.007
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:05.739 0.0%164662 0.019 0.035 0.078
data write00:00:20.272 0.0%154677 0.087 0.131 0.231
idle23:56:42.791100.0%248845 172.734 346.412 966.588
status file00:00:00.200 0.0%195 0.000 1.026 7.000
TOTAL: 23:57:21.71223:57:10.999100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:03.327 75.8%5 0.000 665.400 1653.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.001 0.0%11 0.000 0.091 0.250
TOTAL: 00:00:04.38900:00:03.328 75.8%----

Control commands to INND:

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

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1endofthelinebbs-out.news.weretis.net 4 20187 7165 12757 265 35%44:36:43
2usenet.blueworldhosting.com 5 12401 3112 8973 316 25%24:34:11
3outgoing.news.lysator.liu.se 2 12380 627 11378 375 5%23:59:40
4newsfeed.xs3.de 1 10372 413 9957 2 3%23:59:55
5news.samoylyk.net 2 10541 59 10478 4 0%23:59:39
6glockenspiel.complete.org 2 10768 24 10699 45 0%23:59:43
7news.furie.org.uk 1 6158 21 6137 0 0%23:59:56
8news.bbs.nz 3 16488 15 16473 0 0%36:12:15
9news.netfront.net 2 14749 1 12539 2209 0%24:20:52
10news.nk.ca 2 0 0 0 0 0%00:20:02
11eotl-out.news.tnetconsulting.net 1 0 0 0 0 0%00:10:04
12localhost 25 0 0 0 0 0%00:00:00
TOTAL: 12 50 114044 11437 99391 3216 10%250:13:00
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1endofthelinebbs-out.news.weretis.net27.0 MB0.0 KB501.6 KB27.5 MB 98%3.8 KB
2usenet.blueworldhosting.com18.4 MB0.0 KB1.1 MB19.5 MB 94%5.8 KB
3newsfeed.xs3.de1.7 MB0.0 KB2.5 KB1.7 MB 99%4.2 KB
4outgoing.news.lysator.liu.se1.2 MB0.0 KB1.6 MB2.7 MB 42%2.8 KB
5news.samoylyk.net256.4 KB3.5 KB6.0 KB266.0 KB 96%4.2 KB
6glockenspiel.complete.org142.4 KB0.0 KB83.7 KB226.1 KB 62%3.3 KB
7news.furie.org.uk74.5 KB0.0 KB0.0 KB74.5 KB100%3.5 KB
8news.bbs.nz19.9 KB0.0 KB0.0 KB19.9 KB100%1.3 KB
9news.netfront.net1.1 KB0.0 KB779.0 MB779.0 MB 0%360.9 KB
10news.nk.ca0.0 KB0.0 KB0.0 KB0.0 KB 0%0
11eotl-out.news.tnetconsulting.net0.0 KB0.0 KB0.0 KB0.0 KB 0%0
12localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 1248.8 MB3.5 KB782.2 MB831.0 MB 5%58.1 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Jan 4 00:01:01 - 00:59:59 267 2.3% 0.081.9 MB 3.9% 0.55
Jan 4 01:00:00 - 01:59:59 333 2.9% 0.091.3 MB 2.6% 0.37
Jan 4 02:00:00 - 02:59:59 435 3.8% 0.121.2 MB 2.4% 0.34
Jan 4 03:00:00 - 03:59:59 586 5.1% 0.162.0 MB 4.0% 0.56
Jan 4 04:00:00 - 04:59:59 569 4.9% 0.161.8 MB 3.6% 0.50
Jan 4 05:00:00 - 05:59:59 580 5.0% 0.161.7 MB 3.4% 0.48
Jan 4 06:00:00 - 06:59:59 610 5.3% 0.173.8 MB 7.7% 1.08
Jan 4 07:00:00 - 07:59:59 521 4.5% 0.142.3 MB 4.7% 0.65
Jan 4 08:00:00 - 08:59:59 684 5.9% 0.192.7 MB 5.4% 0.76
Jan 4 09:00:00 - 09:59:59 779 6.7% 0.223.0 MB 6.2% 0.86
Jan 4 10:00:00 - 10:59:59 700 6.1% 0.192.2 MB 4.4% 0.61
Jan 4 11:00:00 - 11:59:59 719 6.2% 0.203.5 MB 7.2% 1.01
Jan 4 12:00:00 - 12:59:59 617 5.3% 0.172.1 MB 4.2% 0.59
Jan 4 13:00:00 - 13:59:59 598 5.2% 0.171.9 MB 3.9% 0.55
Jan 4 14:00:00 - 14:59:59 515 4.5% 0.141.4 MB 2.8% 0.39
Jan 4 15:00:00 - 15:59:59 579 5.0% 0.162.5 MB 5.2% 0.72
Jan 4 16:00:00 - 16:59:59 532 4.6% 0.153.2 MB 6.6% 0.92
Jan 4 17:00:00 - 17:59:59 410 3.6% 0.112.3 MB 4.6% 0.65
Jan 4 18:00:00 - 18:59:59 328 2.8% 0.09991.2 KB 2.0% 0.28
Jan 4 19:00:00 - 19:59:59 247 2.1% 0.071.8 MB 3.6% 0.51
Jan 4 20:00:00 - 20:59:59 232 2.0% 0.061.4 MB 2.9% 0.40
Jan 4 21:00:00 - 21:59:59 237 2.1% 0.072.0 MB 4.0% 0.56
Jan 4 22:00:00 - 22:59:59 199 1.7% 0.061.0 MB 2.1% 0.29
Jan 4 23:00:00 - 23:59:59 262 2.3% 0.071.2 MB 2.5% 0.35
Jan 5 00:00:00 - 00:01:02 8 0.1% 0.1334.7 KB 0.1% 0.56
TOTAL: 24:00:01 11547 100.0% 0.1349.1 MB 100.0% 0.58
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1news.netfront.net 2233 0 0 0 0 0 0 0 2233
2endofthelinebbs-out.news.weretis.net 498 0 0 0 0 0 0 0 498
3outgoing.news.lysator.liu.se 371 0 0 0 0 0 0 0 371
4usenet.blueworldhosting.com 327 21 0 0 3 0 0 0 303
5glockenspiel.complete.org 15 0 0 0 0 0 0 0 15
6news.samoylyk.net 6 0 0 2 0 0 0 0 4
7newsfeed.xs3.de 5 0 0 0 0 0 0 0 5
TOTAL: 7 3455 21 0 2 3 0 0 0 3429

Unwanted newsgroups [Top 20]:

NewsgroupCount
alt.alt.alt 6
rocksolid.feeds.news 4
panix.chat 4
aalt.war.world-war-two 2
rocksolid.feeds.tech 2
panix.test 1
a.b.e-book.flood 1
alt.alt.alt.alt 1
TOTAL: 8 21

Supposedly-moderated groups with unmoderated postings [Top 20]:

GroupsCount
soc.religion.islam 2
soc.answers 1
TOTAL: 2 3

INND Perl filter [Top 20]:

ReasonCount
Binary: misplaced binary 1592
Too many newsgroups (low_xpost) 466
EMP (phn path) 439
EMP (md5) 359
Too many newsgroups 181
EMP (phl) 120
EMP (phn nph) 16
Scoring filter 10
Too many newsgroups (meow) 2
TOTAL: 9 3185

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
endofthelinebbs-out.news.weretis.net 230
usenet.blueworldhosting.com 6
newsfeed.xs3.de 3
news.samoylyk.net 2
outgoing.news.lysator.liu.se 2
glockenspiel.complete.org 1
TOTAL: 6 244
TOTAL: 1 244

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.netfront.net 15508 4969 6575 2 0 17 32%23:59:40
2nyheter.lysator.liu.se 11411 2509 8407 9 0 0 21%23:59:57
3news.furie.org.uk 9510 94 6403 11 0 0 0%23:59:57
4news.nk.ca 15127 46 11396 33 0 17 0%23:59:57
5news.bbs.nz 22494 31 11444 49 0 136 0%23:59:55
6news.quux.org 12181 9 11401 102 0 0 0%23:59:57
7news.weretis.net 11570 2 11542 1 0 0 0%23:59:46
8usenet.blueworldhosting.com 9335 2 8375 0 0 5 0%23:59:45
9newsfeed.xs3.de 13735 0 11122 0 0 0 0%23:59:10
10peer.alt119.net 0 0 0 0 0 11545 0%23:57:48
11news.samoylyk.net 14164 0 11486 0 0 0 0%23:59:57
12news.tnetconsulting.net 12791 0 11539 0 0 19 0%23:59:52
TOTAL: 12 147826 7662 109690 207 0 11739 5%287:55:41
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.netfront.net24.4 MB11.5 KB24.4 MB0.3 KB/s5.0 KB23:59:40
2nyheter.lysator.liu.se14.7 MB180.8 KB14.8 MB0.2 KB/s6.0 KB23:59:57
3news.furie.org.uk4.7 MB116.2 KB4.8 MB0.1 KB/s46.5 KB23:59:57
4news.nk.ca1.8 MB959.3 KB2.7 MB0.0 KB/s35.4 KB23:59:57
5news.bbs.nz868.8 KB2.0 MB2.9 MB0.0 KB/s36.5 KB23:59:55
6news.quux.org719.1 KB2.0 MB2.7 MB0.0 KB/s24.8 KB23:59:57
7news.weretis.net4.3 KB591.1 KB595.4 KB0.0 KB/s198.5 KB23:59:46
8usenet.blueworldhosting.com3.3 KB0.0 KB3.3 KB0.0 KB/s1.7 KB23:59:45
9newsfeed.xs3.de0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:10
10peer.alt119.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:48
11news.samoylyk.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:57
12news.tnetconsulting.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:52
TOTAL: 1247.1 MB5.8 MB52.9 MB0.1 KB/s6.9 KB287:55:41
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1respected.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:01
2107.170.239.10 1 00.0 KB 0 0 000:00:00
3spirited.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:02
4ec2-35-86-229-164.us-west-2.compute.amazonaws.com 1 00.0 KB 0 0 000:00:00
TOTAL: 4 4 00.0 KB 0 0 000:00:04

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1unresolved 1 00.0 KB 0 0 000:00:00
2*.monitoring.internet-measurement.com 2 00.0 KB 0 0 000:00:03
3*.us-west-2.compute.amazonaws.com 1 00.0 KB 0 0 000:00:00
TOTAL: 3 4 00.0 KB 0 0 000:00:04

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
spirited.monitoring.internet-measurement.com 0.072 0.052 0.00000:00:02
respected.monitoring.internet-measurement.com 0.083 0.034 0.00000:00:01
ec2-35-86-229-164.us-west-2.compute.amazonaws.com 0.096 0.045 0.00000:00:00
107.170.239.10 0.089 0.024 0.00000:00:00
TOTAL: 4 0.340 0.155 0.00000:00:04

NNRP unrecognized commands (by host):

SystemConn
107.170.239.10 1
TOTAL: 1 1

NNRP unrecognized commands (by command):

CommandCount
MGLNDD_192.138.210.162_119 1
TOTAL: 1 1