Daily Usenet Report

Nov 2 00:01:01 -- Nov 3 00:01:02

Unknown entries from news log file:

First 1 / 1 lines (100.0%)

Nov 2 00:05:31 www innd: message repeated 2 times: [ ctlinnd command s]

Log entries by program:

Program nameLines%LinesSize%Size
inn 13318 69.7%3.5 MB 78.8%
innd 3425 17.9%512.9 KB 11.4%
innfeed 2325 12.2%435.0 KB 9.7%
nnrpd 22 0.1%2.1 KB 0.0%
controlchan 13 0.1%2.8 KB 0.1%
TOTAL: 5 19103 100.0%4.4 MB100.0%

History cache:

ReasonCount%Count
Positive hits 91781 55.4%
Negative hits 60845 36.7%
Do not exist 12633 7.6%
Cache misses 339 0.2%
TOTAL: 4 165598 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.416 0.0%338 0.000 1.231 4.500
article cleanup00:00:00.247 0.0%12693 0.000 0.019 0.081
article logging00:00:00.603 0.0%12992 0.000 0.046 0.144
article parse00:00:00.381 0.0%20434 0.000 0.019 0.083
article write00:00:12.171 0.0%11350 0.411 1.072 2.934
artlog/artcncl00:00:00.008 0.0%337 0.000 0.024 0.091
artlog/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
artlog/artwrite00:00:00.000 0.0%0 0.000 0.000 0.000
data move00:00:00.192 0.0%166703 0.000 0.001 0.007
hisgrep/artcncl00:00:00.024 0.0%338 0.000 0.071 1.000
hishave/artcncl00:00:00.014 0.0%338 0.000 0.041 0.545
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:05.720 0.0%165766 0.003 0.035 0.071
history sync00:00:00.054 0.0%394 0.000 0.137 1.000
history write00:00:06.018 0.0%12668 0.091 0.475 0.871
hiswrite/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
hiswrite/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
idle23:58:31.695 99.8%164053 193.190 526.121 1803.724
nntp read00:00:07.273 0.0%165221 0.021 0.044 0.090
overview write00:00:07.686 0.0%11350 0.267 0.677 2.345
perl filter00:00:36.357 0.0%12668 2.133 2.870 5.909
python filter00:00:02.053 0.0%12668 0.080 0.162 0.568
site send00:00:04.439 0.0%22701 0.065 0.196 0.786
TOTAL: 24:01:07.21923:59:55.351 99.9%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.154 0.0%12669 0.000 0.012 0.111
article prepare00:00:00.004 0.0%18560 0.000 0.000 0.011
article read00:00:00.926 0.0%3317 0.000 0.279 7.500
backlog stats00:00:00.501 0.0%224101 0.000 0.002 0.007
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:06.005 0.0%152077 0.017 0.039 0.074
data write00:00:19.588 0.0%143374 0.070 0.137 0.235
idle23:56:35.854100.0%224101 144.929 384.629 1144.973
status file00:00:00.193 0.0%186 0.000 1.038 4.000
TOTAL: 23:57:12.82623:57:03.225100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:21.526 84.1%6 0.000 3587.667 10050.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.004 0.0%17 0.000 0.235 0.333
TOTAL: 00:00:25.58600:00:21.530 84.1%----

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

Control Channel:

SendernewgrouprmgroupOtherBad PGPDoItOK
moderator@dana.de001011
TOTAL001011

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1endofthelinebbs-out.news.weretis.net 4 21073 5378 15361 334 25%46:06:39
2usenet.blueworldhosting.com 5 12142 3675 8094 373 30%24:01:13
3peer.alt119.net 3 12686 1800 10270 616 14%24:08:55
4newsfeed.xs3.de 2 10308 366 9929 13 3%23:59:31
5news.samoylyk.net 1 10452 89 10360 3 0%23:59:48
6glockenspiel.complete.org 1 10764 22 10741 1 0%23:59:52
7outgoing.news.lysator.liu.se 2 10697 14 10683 0 0%23:59:31
8news.bbs.nz 2 10637 8 10629 0 0%23:59:43
9news.furie.org.uk 1 5700 0 5700 0 0%23:59:55
10news.nk.ca 3 0 0 0 0 0%00:30:01
11localhost 25 0 0 0 0 0%00:00:00
12eotl-out.news.tnetconsulting.net 1 0 0 0 0 0%00:10:04
TOTAL: 12 50 104459 11352 91767 1340 10%238:55:12
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1usenet.blueworldhosting.com21.8 MB1.5 KB1.1 MB22.9 MB 95%5.8 KB
2endofthelinebbs-out.news.weretis.net16.1 MB36.7 KB878.7 KB17.0 MB 94%3.1 KB
3peer.alt119.net4.0 MB1.4 KB3.2 MB7.2 MB 55%3.1 KB
4newsfeed.xs3.de1.4 MB1.5 KB54.1 KB1.4 MB 96%3.9 KB
5news.samoylyk.net469.3 KB4.2 KB27.4 KB500.9 KB 93%5.4 KB
6glockenspiel.complete.org149.1 KB0.0 KB1.3 KB150.4 KB 99%6.5 KB
7outgoing.news.lysator.liu.se51.5 KB0.0 KB0.0 KB51.5 KB100%3.7 KB
8news.bbs.nz21.9 KB0.0 KB0.0 KB21.9 KB100%2.7 KB
9news.furie.org.uk0.0 KB0.0 KB0.0 KB0.0 KB 0%0
10news.nk.ca0.0 KB0.0 KB0.0 KB0.0 KB 0%0
11localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
12eotl-out.news.tnetconsulting.net0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 1244.0 MB45.3 KB5.3 MB49.3 MB 89%4.0 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Nov 2 00:01:01 - 00:59:59 553 4.9% 0.162.4 MB 5.4% 0.70
Nov 2 01:00:00 - 01:59:59 291 2.6% 0.081.8 MB 4.0% 0.52
Nov 2 02:00:00 - 02:59:59 378 3.3% 0.101.3 MB 2.8% 0.36
Nov 2 03:00:00 - 03:59:59 520 4.6% 0.141.5 MB 3.3% 0.43
Nov 2 04:00:00 - 04:59:59 504 4.4% 0.141.3 MB 2.9% 0.38
Nov 2 05:00:00 - 05:59:59 574 5.1% 0.161.8 MB 4.1% 0.52
Nov 2 06:00:00 - 06:59:59 592 5.2% 0.161.8 MB 3.9% 0.51
Nov 2 07:00:00 - 07:59:59 557 4.9% 0.153.1 MB 6.9% 0.89
Nov 2 08:00:00 - 08:59:59 629 5.5% 0.171.8 MB 3.9% 0.50
Nov 2 09:00:00 - 09:59:59 592 5.2% 0.161.6 MB 3.6% 0.46
Nov 2 10:00:00 - 10:59:59 609 5.4% 0.171.7 MB 3.8% 0.49
Nov 2 11:00:00 - 11:59:59 706 6.2% 0.202.4 MB 5.4% 0.69
Nov 2 12:00:00 - 12:59:59 649 5.7% 0.182.2 MB 5.0% 0.64
Nov 2 13:00:00 - 13:59:59 616 5.4% 0.172.7 MB 6.1% 0.78
Nov 2 14:00:00 - 14:59:59 551 4.9% 0.152.7 MB 5.9% 0.76
Nov 2 15:00:00 - 15:59:59 480 4.2% 0.131.6 MB 3.5% 0.45
Nov 2 16:00:00 - 16:59:59 553 4.9% 0.151.7 MB 3.7% 0.47
Nov 2 17:00:00 - 17:59:59 461 4.1% 0.131.5 MB 3.3% 0.43
Nov 2 18:00:00 - 18:59:59 437 3.9% 0.123.4 MB 7.6% 0.98
Nov 2 19:00:00 - 19:59:59 277 2.4% 0.081.3 MB 2.8% 0.36
Nov 2 20:00:00 - 20:59:59 255 2.2% 0.071.2 MB 2.6% 0.34
Nov 2 21:00:00 - 21:59:59 181 1.6% 0.051006.7 KB 2.2% 0.28
Nov 2 22:00:00 - 22:59:59 181 1.6% 0.051.3 MB 2.8% 0.37
Nov 2 23:00:00 - 23:59:59 192 1.7% 0.052.0 MB 4.5% 0.58
Nov 3 00:00:00 - 00:01:02 1 0.0% 0.022.1 KB 0.0% 0.03
TOTAL: 24:00:01 11339 100.0% 0.1345.2 MB 100.0% 0.54
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1peer.alt119.net 664 8 0 1 0 0 0 0 655
2endofthelinebbs-out.news.weretis.net 571 3 0 17 0 0 0 0 551
3usenet.blueworldhosting.com 376 40 0 1 0 0 0 0 335
4newsfeed.xs3.de 20 2 0 1 0 0 0 0 17
5glockenspiel.complete.org 5 0 0 3 0 0 0 0 2
6news.samoylyk.net 5 0 0 1 0 0 0 0 4
7news.bbs.nz 1 0 0 1 0 0 0 0 0
TOTAL: 7 1642 53 0 25 0 0 0 0 1564

Unwanted newsgroups [Top 20]:

NewsgroupCount
att.jobs 11
at.jobs 8
alt.binaries.pictures.erotica.vintage 6
rocksolid.feeds.news 5
grisbi.bugsreports 5
rocksolid.feeds.tech 3
aus.jobs 3
panix.test 2
fr.petites-annonces.informatique.materiel 2
alt.flame.faggots 1
grisbi.test 1
corelsupport.ventura8 1
alt.music.pink-floyd.publius 1
biz.marketplace 1
alt.christnet.eucharist 1
gun.general 1
alt.magick.astrology 1
TOTAL: 17 53

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 575
EMP (phn path) 488
EMP (phl) 130
Too many newsgroups 38
EMP (phn nph) 17
Scoring filter 12
Too many newsgroups (meow) 5
TOTAL: 7 1265

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
endofthelinebbs-out.news.weretis.net 255
peer.alt119.net 21
usenet.blueworldhosting.com 12
newsfeed.xs3.de 7
news.samoylyk.net 3
glockenspiel.complete.org 1
TOTAL: 6 299
TOTAL: 1 299

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1nyheter.lysator.liu.se 13885 2544 8383 402 0 320 18%23:59:57
2peer.alt119.net 10730 1066 8455 32 0 25 9%23:59:57
3news.nk.ca 15005 112 11123 68 0 613 0%23:59:57
4news.bbs.nz 22019 77 11149 101 0 347 0%23:59:57
5news.quux.org 11932 50 11108 148 0 0 0%23:59:49
6news.furie.org.uk 7976 8 5978 6 0 8 0%23:59:56
7news.weretis.net 11515 7 11331 0 0 0 0%23:59:56
8news.tnetconsulting.net 12651 6 11325 7 0 19 0%23:59:51
9usenet.blueworldhosting.com 7999 0 7637 0 0 0 0%23:59:57
10news.samoylyk.net 14331 0 11247 2 0 3 0%23:59:57
11newsfeed.xs3.de 13285 0 10972 2 0 4 0%23:59:48
12theuse.net 0 0 0 0 0 11338 0%23:59:57
TOTAL: 12 141328 3870 108708 768 0 12677 2%287:58:59
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1nyheter.lysator.liu.se13.8 MB2.3 MB16.1 MB0.2 KB/s5.6 KB23:59:57
2peer.alt119.net6.4 MB203.4 KB6.6 MB0.1 KB/s6.2 KB23:59:57
3news.nk.ca1.0 MB183.6 KB1.2 MB0.0 KB/s6.9 KB23:59:57
4news.bbs.nz489.5 KB1002.0 KB1.5 MB0.0 KB/s8.4 KB23:59:57
5news.quux.org283.6 KB817.3 KB1.1 MB0.0 KB/s5.6 KB23:59:49
6news.furie.org.uk117.4 KB68.5 KB185.9 KB0.0 KB/s13.3 KB23:59:56
7news.tnetconsulting.net79.7 KB8.9 KB88.6 KB0.0 KB/s6.8 KB23:59:51
8news.weretis.net24.5 KB0.0 KB24.5 KB0.0 KB/s3.5 KB23:59:56
9usenet.blueworldhosting.com0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:57
10news.samoylyk.net0.0 KB8.0 KB8.0 KB0.0 KB/s4.0 KB23:59:57
11newsfeed.xs3.de0.0 KB3.2 KB3.2 KB0.0 KB/s1.6 KB23:59:48
12theuse.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:57
TOTAL: 1222.2 MB4.5 MB26.7 MB0.0 KB/s5.9 KB287:58:59
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
127.124.5.23 2 00.0 KB 0 0 000:00:15
2ec2-54-151-108-17.us-west-1.compute.amazonaws.com 1 00.0 KB 0 0 000:00:00
3107.174.172.167 1 00.0 KB 0 0 000:00:10
TOTAL: 3 4 00.0 KB 0 0 000:00:25

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1unresolved 3 00.0 KB 0 0 000:00:25
2*.us-west-1.compute.amazonaws.com 1 00.0 KB 0 0 000:00:00
TOTAL: 2 4 00.0 KB 0 0 000:00:25

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
27.124.5.23 0.172 0.104 0.00000:00:15
107.174.172.167 0.081 0.037 0.00000:00:10
ec2-54-151-108-17.us-west-1.compute.amazonaws.com 0.075 0.022 0.00000:00:00
TOTAL: 3 0.328 0.163 0.00000:00:25

NNRP unrecognized commands (by host):

SystemConn
27.124.5.23 3
TOTAL: 1 3

NNRP unrecognized commands (by command):

CommandCount
cS16ÀRÓî#036Žˆ#020´æ¼…Ù€#003#004—ÓöÑ#025e#036= 1
#001 1
#026#003#001 1
TOTAL: 3 3

NNRP client timeouts [Top 20]:

SystemConnPeer
27.124.5.23 1 1
TOTAL: 1 1 1