Daily Usenet report for csiph.com

Oct 4 04:15:00 -- Oct 5 04:15:00

Unknown entries from news log file:

First 2 / 2 lines (100.0%)

Oct 4 17:30:34 csiph pgpverify[84332]: pgpverify: verification failed
Oct 4 17:30:57 csiph pgpverify[84342]: pgpverify: verification failed

Log entries by program:

Program nameLines%LinesSize%Size
inn 42787 61.2%8.0 MB 72.1%
innd 22918 32.8%2.5 MB 22.2%
innfeed 3222 4.6%534.1 KB 4.7%
nnrpd 949 1.4%107.0 KB 0.9%
nocem 50 0.1%4.8 KB 0.0%
controlchan 7 0.0%0.9 KB 0.0%
pgpverify 2 0.0%0.2 KB 0.0%
TOTAL: 7 69935 100.0%11.1 MB100.0%

History cache:

ReasonCount%Count
Positive hits 447973 55.3%
Negative hits 318542 39.3%
Do not exist 41815 5.2%
Cache misses 2111 0.3%
TOTAL: 4 810441 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:01.497 0.0%189 0.000 7.921 99.000
article cleanup00:00:00.277 0.0%41963 0.000 0.007 0.025
article logging00:00:00.593 0.0%42491 0.000 0.014 0.144
article parse00:00:01.532 0.0%140980 0.003 0.011 0.062
article write00:06:41.353 0.5%23519 0.194 17.065 79.174
artlog/artcncl00:00:00.000 0.0%170 0.000 0.000 0.000
artlog/artparse00:00:00.004 0.0%188 0.000 0.021 1.000
data move00:00:00.284 0.0%746063 0.000 0.000 0.001
hisgrep/artcncl00:00:00.249 0.0%179 0.000 1.391 53.000
hishave/artcncl00:00:00.023 0.0%189 0.000 0.122 2.000
hishave/artparse00:00:00.000 0.0%186 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:22.403 0.0%816418 0.001 0.027 0.518
history sync00:00:01.243 0.0%352 0.000 3.531 42.333
history write00:01:02.230 0.1%41897 0.061 1.485 23.887
hiswrite/artcncl00:00:00.008 0.0%10 0.000 0.800 1.143
hiswrite/artparse00:00:00.168 0.0%185 0.000 0.908 50.000
idle23:48:18.146 99.1%756263 67.347 113.318 370.201
nntp read00:00:02.751 0.0%773839 0.001 0.004 0.015
overview write00:01:29.522 0.1%23519 0.200 3.806 58.865
perl filter00:01:51.787 0.1%41816 1.540 2.673 4.245
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:00:00.426 0.0%47084 0.000 0.009 0.024
TOTAL: 24:00:47.81423:59:54.496 99.9%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.085 0.0%24344 0.000 0.003 0.024
article prepare00:00:00.005 0.0%27136 0.000 0.000 0.006
article read00:00:04.090 0.0%4055 0.000 1.009 8.962
backlog stats00:00:00.208 0.0%437136 0.000 0.000 0.002
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:01.811 0.0%334919 0.001 0.005 0.011
data write00:00:02.369 0.0%318033 0.003 0.007 0.013
idle23:53:00.923100.0%437136 113.459 196.691 555.416
status file00:00:00.402 0.0%288 0.000 1.396 11.000
TOTAL: 23:53:21.98723:53:09.893100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
hisgrep00:00:00.092 0.0%79 0.000 1.165 35.000
idle61:35:01.195100.0%484 1085.500458060.3201170938.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.008 0.0%1082 0.000 0.007 0.250
readart00:00:00.506 0.0%28 0.000 18.071 66.000
TOTAL: 61:35:42.79361:35:01.801100.0%----

Control commands to INND:

CommandNumber
L 1
flush 5
flushlogs 2
go 2
logmode 2
mode 141
pause 2
paused 2
reload 2
reserve 2
TOTAL: 10 161

Control Channel:

SendernewgrouprmgroupOtherBad PGPDoItOK
grisbi-control@grisbi.org000200
TOTAL000200

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1csiph-out.feeder.erje.net 1152 129991 5177 116175 8639 3%94:58:00
2csiph-out.news.weretis.net 5 56529 4134 51264 1131 7%51:07:24
3feeder.eternal-september.org 4 37282 3088 33524 670 8%24:37:35
4news-out.mixmin.net 3 26873 2634 23672 567 9%24:02:37
5news-out.aioe.org 1 23236 2049 21170 17 8%23:59:57
6newsfeeds.xmission.com 1 22724 1824 20874 26 8%22:51:52
7newsfeed.neva.ru 149 54004 1635 45513 6856 3%70:57:31
8newsfeed.fu-berlin.de 46 25075 1110 23640 325 4%31:31:14
9news.fcku.it 1 10502 688 9652 162 6%23:59:57
10news.redatomik.org 2 21931 653 21206 72 2%20:47:19
11xanadu-bbs.net 8 813 198 610 5 24%23:47:09
12news.freedyn.net 3 26135 47 26060 28 0%23:58:46
13news.swapon.de 1 1955 44 1911 0 2%25:36:41
14nntp.pasdenom.info 3 39703 32 39624 47 0%24:08:38
15news.bbs.geek.nz 2 22032 4 22028 0 0%23:59:47
16localhost 33 0 0 0 0 0%00:00:00
TOTAL: 16 1414 498785 23317 456923 18545 4%510:24:27
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1csiph-out.feeder.erje.net16.4 MB533.1 KB44.5 MB61.4 MB 26%4.6 KB
2csiph-out.news.weretis.net11.1 MB2.0 KB12.3 MB23.3 MB 47%4.5 KB
3news-out.mixmin.net9.3 MB2.2 KB1.4 MB10.7 MB 86%3.4 KB
4feeder.eternal-september.org7.9 MB7.0 KB10.4 MB18.3 MB 42%5.0 KB
5news-out.aioe.org5.2 MB0.0 KB17.8 KB5.2 MB 99%2.6 KB
6newsfeeds.xmission.com4.6 MB0.0 KB1.2 MB5.9 MB 78%3.2 KB
7newsfeed.neva.ru4.5 MB187.5 KB65.6 MB70.3 MB 6%8.5 KB
8newsfeed.fu-berlin.de2.3 MB0.0 KB737.4 KB3.1 MB 76%2.2 KB
9news.redatomik.org1.8 MB0.0 KB269.9 KB2.1 MB 87%3.0 KB
10news.fcku.it1.4 MB0.0 KB1.1 MB2.5 MB 55%3.1 KB
11xanadu-bbs.net531.8 KB0.0 KB9.5 KB541.3 KB 98%2.7 KB
12news.freedyn.net200.0 KB0.0 KB1.7 MB1.9 MB 10%26.4 KB
13news.swapon.de124.1 KB0.0 KB0.0 KB124.1 KB100%2.8 KB
14nntp.pasdenom.info70.6 KB0.0 KB383.2 KB453.8 KB 15%5.7 KB
15news.bbs.geek.nz5.1 KB0.0 KB0.0 KB5.1 KB100%1.3 KB
16localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 1665.4 MB731.8 KB139.7 MB205.8 MB 31%5.0 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Oct 4 04:15:00 - 04:59:59 431 1.8% 0.161.6 MB 2.5% 0.61
Oct 4 05:00:00 - 05:59:59 505 2.2% 0.141.6 MB 2.5% 0.47
Oct 4 06:00:00 - 06:59:59 688 2.9% 0.192.3 MB 3.6% 0.66
Oct 4 07:00:00 - 07:59:59 1049 4.5% 0.292.9 MB 4.4% 0.83
Oct 4 08:00:00 - 08:59:59 1065 4.5% 0.302.8 MB 4.3% 0.81
Oct 4 09:00:00 - 09:59:59 1066 4.5% 0.302.5 MB 3.8% 0.71
Oct 4 10:00:00 - 10:59:59 1170 5.0% 0.333.0 MB 4.6% 0.86
Oct 4 11:00:00 - 11:59:59 1059 4.5% 0.292.9 MB 4.3% 0.81
Oct 4 12:00:00 - 12:59:59 1290 5.5% 0.363.5 MB 5.3% 0.99
Oct 4 13:00:00 - 13:59:59 1288 5.5% 0.363.3 MB 5.1% 0.95
Oct 4 14:00:00 - 14:59:59 1392 5.9% 0.393.9 MB 5.9% 1.10
Oct 4 15:00:00 - 15:59:59 1373 5.8% 0.383.6 MB 5.6% 1.04
Oct 4 16:00:00 - 16:59:59 1437 6.1% 0.404.2 MB 6.5% 1.21
Oct 4 17:00:00 - 17:59:59 1293 5.5% 0.363.3 MB 5.1% 0.95
Oct 4 18:00:00 - 18:59:59 1271 5.4% 0.353.3 MB 5.1% 0.94
Oct 4 19:00:00 - 19:59:59 1149 4.9% 0.323.0 MB 4.6% 0.86
Oct 4 20:00:00 - 20:59:59 1163 5.0% 0.323.9 MB 5.9% 1.10
Oct 4 21:00:00 - 21:59:59 1047 4.5% 0.292.7 MB 4.1% 0.76
Oct 4 22:00:00 - 22:59:59 854 3.6% 0.242.6 MB 3.9% 0.73
Oct 4 23:00:00 - 23:59:59 733 3.1% 0.202.1 MB 3.2% 0.59
Oct 5 00:00:00 - 00:59:59 613 2.6% 0.171.7 MB 2.6% 0.49
Oct 5 01:00:00 - 01:59:59 472 2.0% 0.131.5 MB 2.2% 0.41
Oct 5 02:00:00 - 02:59:59 464 2.0% 0.131.4 MB 2.1% 0.39
Oct 5 03:00:00 - 03:59:59 481 2.0% 0.131.6 MB 2.4% 0.45
Oct 5 04:00:00 - 04:15:00 118 0.5% 0.13343.6 KB 0.5% 0.38
TOTAL: 24:00:00 23471 100.0% 0.2765.6 MB 100.0% 0.78
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1csiph-out.feeder.erje.net 8665 440 0 52 0 0 0 0 8173
2newsfeed.neva.ru 6949 939 0 12 0 0 0 0 5998
3csiph-out.news.weretis.net 1137 273 0 1 0 0 0 0 863
4feeder.eternal-september.org 735 57 0 2 0 0 0 0 676
5newsfeed.fu-berlin.de 659 47 0 0 0 0 0 0 612
6news-out.mixmin.net 590 22 0 1 0 0 0 0 567
7news.fcku.it 168 0 0 0 0 0 0 0 168
8news.redatomik.org 101 0 0 0 0 0 0 0 101
9nntp.pasdenom.info 50 0 0 0 0 0 0 0 50
10newsfeeds.xmission.com 31 6 0 0 0 0 0 0 25
11news-out.aioe.org 29 17 0 0 0 0 0 0 12
12news.freedyn.net 27 0 0 0 0 0 0 0 27
13xanadu-bbs.net 5 0 0 0 0 0 0 0 5
14news.swapon.de 1 0 0 0 0 0 0 0 1
TOTAL: 14 19147 1801 0 68 0 0 0 017278

Unwanted newsgroups [Top 20]:

NewsgroupCount
fa.linux.kernel 472
lada.talk 182
ut.test 121
alt.survival 83
lada.photo 57
alt.windows7.general 54
it-alt.sport.calcio.juventus 54
lada.auto 53
fa.freebsd.cvs-all 41
fa.openbsd.source-changes 36
mpc.lists.nanog 34
mozilla.support.thunderbird 33
fa.philos-l 27
mozilla.support.seamonkey 26
mozilla.dev.security.policy 23
mpc.lists.freebsd.ports.bugs 20
gmane.linux.kernel 20
fa.openbsd.tech 19
fa.netbsd.bugs 17
it.annunci.commerciali 15
TOTAL: 153 1801

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 13045
EMP (phn path) 2400
EMP (phl) 596
EMP (phn nph) 130
Too many newsgroups 50
User-issued cancel 27
Scoring filter (18) 23
Too many newsgroups (low_xpost) 20
Scoring filter (14) 19
Scoring filter (17) 17
Scoring filter (8) 16
Binary Payload 14
HTML post 12
Scoring filter (12) 11
Scoring filter (16) 11
Scoring filter (19) 11
Scoring filter (10) 10
HTML Multipart 10
Scoring filter (13) 10
Scoring filter (20) 9
TOTAL: 29 16482

NoCeM on Spool:

IdGoodBadUniqueTotal
bleachbot@httrack.com4404444
TOTAL: 14404444

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Article posted in the future
csiph-out.feeder.erje.net 75
TOTAL: 1 75
Bad Message-ID's offered
csiph-out.feeder.erje.net 4
TOTAL: 1 4
Huge articles
feeder.eternal-september.org 101
csiph-out.news.weretis.net 28
newsfeeds.xmission.com 21
news.freedyn.net 15
news-out.mixmin.net 7
news.fcku.it 6
news.redatomik.org 4
nntp.pasdenom.info 3
newsfeed.fu-berlin.de 2
TOTAL: 9 187
Including strange strings
newsfeed.fu-berlin.de 339
feeder.eternal-september.org 50
csiph-out.news.weretis.net 39
news-out.mixmin.net 33
csiph-out.feeder.erje.net 27
news.redatomik.org 13
news-out.aioe.org 12
newsfeed.neva.ru 9
newsfeeds.xmission.com 4
news.fcku.it 1
TOTAL: 11 528
No colon-space in header
csiph-out.feeder.erje.net 1
TOTAL: 1 1
TOTAL: 5 795

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.bbs.geek.nz 42331 2530 20266 44 0 0 5%23:59:51
2news.freedyn.net 24419 1187 22229 6 0 0 4%23:59:51
3xanadu-bbs 25346 663 22586 0 0 63 2%23:59:51
4fu-berlin.de 22108 527 21581 0 0 0 2%23:59:46
5usenet.pasdenom.info 26211 237 22126 1073 0 0 0%23:59:46
6erje 18742 215 17921 68 0 0 1%23:59:37
7xmission 24558 39 20930 2 0 0 0%23:59:51
8aioe 20640 37 19680 8 0 0 0%23:59:51
9news.redatomik.org 23497 33 22064 13 0 7 0%23:59:51
10weretis.net 17431 24 16696 1 0 0 0%23:59:51
11eternal-september 21169 20 19320 1 0 0 0%23:59:42
12neva.ru 22574 7 21355 48 0 283 0%23:59:13
13news.mixmin.net 20558 1 19830 0 0 0 0%23:59:43
14news.fcku.it 3128 1 2983 0 0 0 0%23:09:24
15bwh 0 0 0 0 0 22828 0%23:58:39
16news.swapon.de 1978 0 1905 1 0 0 0%23:52:10
17au2pb 0 0 0 0 0 22845 0%23:58:41
TOTAL: 17 314690 5521 271472 1265 0 46026 1%406:55:38
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.freedyn.net6.3 MB30.9 KB6.3 MB0.1 KB/s5.4 KB23:59:51
2news.bbs.geek.nz6.1 MB135.0 KB6.3 MB0.1 KB/s2.5 KB23:59:51
3xanadu-bbs5.0 MB0.0 KB5.0 MB0.1 KB/s7.7 KB23:59:51
4fu-berlin.de4.7 MB0.0 KB4.7 MB0.1 KB/s9.0 KB23:59:46
5erje646.6 KB396.4 KB1.0 MB0.0 KB/s3.7 KB23:59:37
6usenet.pasdenom.info610.5 KB5.6 MB6.2 MB0.1 KB/s4.9 KB23:59:46
7xmission155.1 KB3.8 KB159.0 KB0.0 KB/s3.9 KB23:59:51
8aioe122.2 KB23.7 KB145.9 KB0.0 KB/s3.2 KB23:59:51
9weretis.net101.7 KB16.7 KB118.4 KB0.0 KB/s4.7 KB23:59:51
10news.redatomik.org86.0 KB57.1 KB143.0 KB0.0 KB/s3.1 KB23:59:51
11eternal-september77.5 KB1.1 KB78.6 KB0.0 KB/s3.7 KB23:59:42
12neva.ru9.8 KB144.9 KB154.7 KB0.0 KB/s2.8 KB23:59:13
13news.mixmin.net5.2 KB0.0 KB5.2 KB0.0 KB/s5.2 KB23:59:43
14news.fcku.it5.1 KB0.0 KB5.1 KB0.0 KB/s5.1 KB23:09:24
15bwh0.0 KB0.0 KB0.0 KB0.0 KB/s023:58:39
16news.swapon.de0.0 KB2.9 KB2.9 KB0.0 KB/s2.9 KB23:52:10
17au2pb0.0 KB0.0 KB0.0 KB0.0 KB/s023:58:41
TOTAL: 1723.8 MB6.4 MB30.2 MB0.0 KB/s4.6 KB406:55:38
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1challenger.nielsenmedia.com 17 1433.1 KB 7 0 004:39:55
250-200-179-74-static.hfc.comcastbusiness.net 2 730.9 KB 3 0 001:00:38
3tempe0.bbox.io 9 36.1 KB 2 0 002:39:03
4cpc8-smal14-2-0-cust979.19-1.cable.virginm.net 2 25.1 KB 1 0 001:00:58
568-185-181-64.dhcp.mdsn.wi.charter.com 3 11.5 KB 1 0 000:58:00
6dhcp-089-099-203-254.chello.nl 49 11.5 KB 1 0 013:14:20
TOTAL: 6 82 2878.2 KB 15 0 061:35:41

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.nielsenmedia.com 17 1433.1 KB 7 0 004:39:55
2*.hfc.comcastbusiness.net 2 730.9 KB 3 0 001:00:38
3*.bbox.io 9 36.1 KB 2 0 002:39:03
4*.19-1.cable.virginm.net 2 25.1 KB 1 0 001:00:58
5*.chello.nl 49 11.5 KB 1 0 013:14:20
6*.dhcp.mdsn.wi.charter.com 3 11.5 KB 1 0 000:58:00
7unresolved 75 00.0 KB 0 0 038:02:43
TOTAL: 7 157 2878.2 KB 15 0 061:35:41

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
216.246.166.122 6.093 1.556 0.00038:02:43
dhcp-089-099-203-254.chello.nl 4.038 1.080 0.00013:14:20
challenger.nielsenmedia.com 1.703 0.357 0.00004:39:55
tempe0.bbox.io 0.921 0.238 0.00002:39:03
cpc8-smal14-2-0-cust979.19-1.cable.virginm.net 0.189 0.055 0.00001:00:58
50-200-179-74-static.hfc.comcastbusiness.net 0.290 0.079 0.00001:00:38
68-185-181-64.dhcp.mdsn.wi.charter.com 0.300 0.056 0.00000:58:00
TOTAL: 7 13.534 3.421 0.00061:35:41

Curious NNRP server explorers [Top 20]:

SystemConn
216.246.166.122 75
TOTAL: 1 75

NNRP client timeouts [Top 20]:

SystemConnPeer
216.246.166.122 70 0
challenger.nielsenmedia.com 7 0
tempe0.bbox.io 5 0
50-200-179-74-static.hfc.comcastbusiness.net 2 0
cpc8-smal14-2-0-cust979.19-1.cable.virginm.net 2 0
68-185-181-64.dhcp.mdsn.wi.charter.com 1 0
TOTAL: 6 87 0

Newsgroup request counts (by category):

CategoryCountPct
1comp 27 96.4%
2news 1 3.6%
TOTAL: 2 28100.0%

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

NewsgroupCount
1comp.lang.awk 14
2comp.arch.storage 6
3comp.sys.ibm.ps2.hardware 4
4comp.lang.pl1 2
5comp.arch 1
6news.admin.peering 1
TOTAL: 6 28
Valid XHTML 1.1 Strict CSS is valid!
innreport 3.1.0 (c) 1996-1999 by Fabien Tassin <fta@sofaraway.org>
Local contact: admin@kev009.com