Daily Usenet report for csiph.com

Feb 22 04:15:00 -- Feb 23 04:15:00

Unknown entries from news log file:

First 1 / 1 lines (100.0%)

Feb 22 11:23:37 csiph pgpverify[94555]: pgpverify: verification failed

Log entries by program:

Program nameLines%LinesSize%Size
inn 54705 41.8%10.2 MB 57.9%
nnrpd 44773 34.2%4.0 MB 22.6%
innd 28302 21.6%2.9 MB 16.3%
innfeed 3202 2.4%555.9 KB 3.1%
nocem 35 0.0%3.3 KB 0.0%
controlchan 4 0.0%0.5 KB 0.0%
pgpverify 1 0.0%0.1 KB 0.0%
TOTAL: 7 131022 100.0%17.6 MB100.0%

History cache:

ReasonCount%Count
Positive hits 605894 55.5%
Negative hits 431901 39.5%
Do not exist 53830 4.9%
Cache misses 858 0.1%
TOTAL: 4 1092483 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.444 0.0%164 0.000 2.707 16.000
article cleanup00:00:00.281 0.0%53287 0.000 0.005 0.024
article logging00:00:00.727 0.0%53771 0.000 0.014 0.064
article parse00:00:02.713 0.0%228346 0.003 0.012 0.159
article write00:00:56.746 0.1%29377 0.177 1.932 7.250
artlog/artcncl00:00:00.002 0.0%153 0.000 0.013 0.250
artlog/artparse00:00:00.007 0.0%693 0.000 0.010 0.071
data move00:00:00.370 0.0%1050310 0.000 0.000 0.001
hisgrep/artcncl00:00:00.045 0.0%163 0.000 0.276 15.000
hishave/artcncl00:00:00.002 0.0%164 0.000 0.012 0.500
hishave/artparse00:00:00.000 0.0%309 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:14.896 0.0%1095042 0.002 0.014 0.063
history sync00:00:02.510 0.0%299 0.000 8.395 79.500
history write00:01:47.840 0.1%53622 0.076 2.011 13.913
hiswrite/artcncl00:00:00.000 0.0%1 0.000 0.000 0.000
hiswrite/artparse00:00:00.777 0.0%309 0.000 2.515 76.000
idle23:51:52.695 99.4%1078073 49.562 79.691 256.941
nntp read00:00:03.572 0.0%1088830 0.001 0.003 0.007
overview write00:01:32.917 0.1%29377 0.830 3.163 23.338
perl filter00:02:26.753 0.2%53228 1.510 2.757 4.531
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:00:00.503 0.0%58785 0.000 0.009 0.037
TOTAL: 24:00:10.90623:59:03.800 99.9%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.093 0.0%29489 0.000 0.003 0.019
article prepare00:00:00.008 0.0%30796 0.000 0.000 0.007
article read00:00:00.596 0.0%3425 0.000 0.174 4.182
backlog stats00:00:00.306 0.0%689276 0.000 0.000 0.001
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:02.486 0.0%503577 0.002 0.005 0.011
data write00:00:03.126 0.0%484676 0.002 0.006 0.012
idle23:52:05.638100.0%689276 66.011 124.661 406.123
status file00:00:00.185 0.0%308 0.000 0.601 1.000
TOTAL: 23:52:24.21223:52:12.438100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
hisgrep00:00:08.155 0.0%90406 0.000 0.090 13.000
idle195:32:40.789 99.9%149478 78.121 4709.461600216.333
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:07.934 0.0%300291 0.000 0.026 30.310
readart00:00:37.173 0.0%21251 0.000 1.749 54.000
TOTAL: 195:49:30.792195:33:34.051 99.9%----

Control commands to INND:

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

Control Channel:

SendernewgrouprmgroupOtherBad PGPDoItOK
control@usenet.org.uk000100
TOTAL000100

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1usenet.blueworldhosting.com 288 35605 6126 26302 3177 17%23:44:51
2csiph-out.feeder.erje.net 1152 111067 5062 103951 2054 4%94:58:01
3feeder.eternal-september.org 2 48319 4729 40263 3327 9%24:00:30
4news-out.aioe.org 5 28903 2639 26213 51 9%24:07:32
5news-out.mixmin.net 1 33347 2626 29098 1623 7%23:59:48
6csiph-out.news.weretis.net 5 67325 2510 64374 441 3%53:51:00
7newsfeed.neva.ru 141 62968 2134 50641 10193 3%71:39:19
8newsfeed.fu-berlin.de 61 32008 1437 30187 384 4%34:40:18
9news.redatomik.org 4 35703 556 35140 7 1%30:28:44
10news.fcku.it 1 10112 486 9618 8 4%24:37:41
11newsfeeds.xmission.com 1 25880 382 25485 13 1%21:11:40
12news.freedyn.net 3 33830 368 33251 211 1%24:10:01
13xanadu-bbs.net 3 53663 151 50347 3165 0%28:10:12
14au2pb.net 1 32840 144 32648 48 0%26:13:07
15news.swapon.de 4 2865 136 2679 50 4%24:08:53
16nntp.pasdenom.info 3 29575 15 29558 2 0%24:08:36
17news.bbs.geek.nz 1 25594 9 25585 0 0%23:59:47
18localhost 37 5 5 0 0 100%00:00:00
TOTAL: 18 1713 669609 29515 615340 24754 4%578:10:00
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1csiph-out.feeder.erje.net19.3 MB45.6 KB6.7 MB26.0 MB 73%3.7 KB
2usenet.blueworldhosting.com17.9 MB0.0 KB31.1 MB49.1 MB 36%5.4 KB
3feeder.eternal-september.org11.8 MB53.6 KB35.8 MB47.7 MB 24%6.1 KB
4news-out.mixmin.net9.4 MB17.8 KB3.3 MB12.7 MB 73%3.1 KB
5csiph-out.news.weretis.net8.2 MB0.0 KB9.3 MB17.5 MB 46%6.1 KB
6newsfeed.neva.ru7.6 MB101.7 KB101.3 MB108.9 MB 6%9.0 KB
7news-out.aioe.org6.4 MB0.0 KB79.2 KB6.5 MB 98%2.5 KB
8newsfeed.fu-berlin.de3.1 MB2.2 KB913.3 KB4.0 MB 77%2.3 KB
9news.freedyn.net1.5 MB0.0 KB1.2 MB2.8 MB 55%4.9 KB
10news.redatomik.org1.2 MB15.4 KB165.3 KB1.4 MB 86%2.5 KB
11newsfeeds.xmission.com1.0 MB0.0 KB220.2 KB1.3 MB 82%3.3 KB
12news.fcku.it971.6 KB0.0 KB128.6 KB1.1 MB 88%2.2 KB
13xanadu-bbs.net513.6 KB26.2 KB29.6 MB30.1 MB 1%9.3 KB
14au2pb.net362.0 KB0.0 KB184.4 KB546.5 KB 66%2.8 KB
15news.swapon.de311.7 KB0.0 KB141.9 KB453.5 KB 68%2.4 KB
16nntp.pasdenom.info25.1 KB0.0 KB66.7 KB91.8 KB 27%5.4 KB
17news.bbs.geek.nz10.7 KB0.0 KB0.0 KB10.7 KB100%1.2 KB
18localhost9.2 KB0.0 KB0.0 KB9.2 KB100%1.8 KB
TOTAL: 1889.7 MB262.5 KB220.3 MB310.2 MB 28%5.9 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Feb 22 04:15:00 - 04:59:59 304 1.0% 0.11896.2 KB 1.0% 0.33
Feb 22 05:00:00 - 05:59:59 622 2.1% 0.172.3 MB 2.6% 0.65
Feb 22 06:00:00 - 06:59:59 562 1.9% 0.162.2 MB 2.4% 0.62
Feb 22 07:00:00 - 07:59:59 793 2.7% 0.222.9 MB 3.3% 0.83
Feb 22 08:00:00 - 08:59:59 1325 4.5% 0.374.6 MB 5.1% 1.30
Feb 22 09:00:00 - 09:59:59 1430 4.9% 0.405.0 MB 5.6% 1.42
Feb 22 10:00:00 - 10:59:59 1371 4.7% 0.383.6 MB 4.0% 1.03
Feb 22 11:00:00 - 11:59:59 1374 4.7% 0.383.7 MB 4.2% 1.06
Feb 22 12:00:00 - 12:59:59 1429 4.9% 0.404.1 MB 4.5% 1.15
Feb 22 13:00:00 - 13:59:59 1515 5.2% 0.424.1 MB 4.6% 1.16
Feb 22 14:00:00 - 14:59:59 1670 5.7% 0.464.1 MB 4.6% 1.17
Feb 22 15:00:00 - 15:59:59 1621 5.5% 0.454.7 MB 5.2% 1.33
Feb 22 16:00:00 - 16:59:59 1696 5.8% 0.474.9 MB 5.4% 1.38
Feb 22 17:00:00 - 17:59:59 1707 5.8% 0.474.6 MB 5.1% 1.30
Feb 22 18:00:00 - 18:59:59 1774 6.0% 0.495.2 MB 5.8% 1.48
Feb 22 19:00:00 - 19:59:59 1670 5.7% 0.464.6 MB 5.2% 1.32
Feb 22 20:00:00 - 20:59:59 1570 5.3% 0.445.0 MB 5.6% 1.42
Feb 22 21:00:00 - 21:59:59 1719 5.9% 0.485.3 MB 5.9% 1.52
Feb 22 22:00:00 - 22:59:59 1427 4.9% 0.404.7 MB 5.2% 1.33
Feb 22 23:00:00 - 23:59:59 1002 3.4% 0.283.4 MB 3.8% 0.97
Feb 23 00:00:00 - 00:59:59 757 2.6% 0.212.6 MB 2.9% 0.75
Feb 23 01:00:00 - 01:59:59 693 2.4% 0.192.3 MB 2.6% 0.66
Feb 23 02:00:00 - 02:59:59 629 2.1% 0.172.3 MB 2.5% 0.64
Feb 23 03:00:00 - 03:59:59 542 1.8% 0.151.8 MB 2.0% 0.51
Feb 23 04:00:00 - 04:15:00 173 0.6% 0.19918.4 KB 1.0% 1.02
TOTAL: 24:00:00 29375 100.0% 0.3489.6 MB 100.0% 1.06
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1newsfeed.neva.ru 10282 1489 0 19 0 0 0 0 8774
2feeder.eternal-september.org 3380 124 0 9 0 0 0 0 3247
3usenet.blueworldhosting.com 3186 1104 0 0 2 0 0 0 2080
4xanadu-bbs.net 3003 21 0 2 0 0 0 0 2980
5csiph-out.feeder.erje.net 2093 333 0 15 1 0 0 0 1744
6news-out.mixmin.net 1642 2 0 3 0 0 0 0 1637
7newsfeed.fu-berlin.de 723 56 0 1 0 0 0 0 666
8csiph-out.news.weretis.net 448 215 0 0 0 0 0 0 233
9news.freedyn.net 212 5 0 0 0 0 0 0 207
10news.swapon.de 68 0 0 0 0 0 0 0 68
11news-out.aioe.org 58 36 0 0 0 0 0 0 22
12au2pb.net 45 39 0 0 0 0 0 0 6
13newsfeeds.xmission.com 15 12 0 0 0 0 0 0 3
14news.fcku.it 10 0 0 0 0 0 0 0 10
15news.redatomik.org 10 0 0 0 0 0 0 0 10
16nntp.pasdenom.info 2 1 0 0 0 0 0 0 1
TOTAL: 16 25177 3437 0 49 3 0 0 021688

Unwanted newsgroups [Top 20]:

NewsgroupCount
fa.linux.kernel 1146
lada.talk 127
mailing.freebsd.pkg-fallout 107
ut.test 86
mailing.freebsd.ports-bugs 73
mailing.freebsd.svn-ports-all 67
mailing.freebsd.svn-ports-head 64
mailing.database.pgsql-general 58
lada.auto 57
mozilla.dev.tree-alerts 49
mailing.openssl.dev 47
spline.eisfair 47
mailing.openssl.cvs 44
gmane.linux.alsa.devel 44
mailing.freebsd.svn-src-all 41
fa.freebsd.cvs-all 41
fa.philos-l 35
mailing.freebsd.svn-src-head 34
it-alt.sport.calcio.juventus 32
mailing.openbsd.misc 29
TOTAL: 288 3437

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

GroupsCount
it.scienza.astronomia 1
muc.lists.freebsd.questions 1
misc.taxes.moderated 1
TOTAL: 3 3

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 15116
EMP (phn path) 3295
EMP (phl) 882
PFM bot misc 327
Binary: misplaced rar 281
EMP (phn nph) 174
Scoring filter (9) 67
Too many newsgroups 63
User-issued cancel 45
HTML Multipart 31
Scoring filter (8) 31
Scoring filter (23) 21
Scoring filter (19) 20
Scoring filter (20) 19
Binary Payload 18
Scoring filter (10) 16
Scoring filter (12) 14
Scoring filter (11) 10
Scoring filter (21) 9
HTML Image Tags 8
TOTAL: 34 20507

NoCeM on Spool:

IdGoodBadUniqueTotal
bleachbot@httrack.com3003131
TOTAL: 13003131

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Article posted in the future
csiph-out.feeder.erje.net 9
usenet.blueworldhosting.com 1
TOTAL: 2 10
Bad Message-ID's offered
csiph-out.feeder.erje.net 4
usenet.blueworldhosting.com 1
TOTAL: 2 5
Huge articles
xanadu-bbs.net 121
csiph-out.news.weretis.net 69
feeder.eternal-september.org 44
usenet.blueworldhosting.com 43
news-out.mixmin.net 9
news.freedyn.net 4
news.fcku.it 3
newsfeeds.xmission.com 3
newsfeed.fu-berlin.de 3
news.redatomik.org 3
TOTAL: 11 303
Including strange strings
newsfeed.fu-berlin.de 345
csiph-out.feeder.erje.net 38
csiph-out.news.weretis.net 29
news-out.mixmin.net 20
news.swapon.de 18
news-out.aioe.org 13
feeder.eternal-september.org 12
newsfeed.neva.ru 5
news.redatomik.org 2
news.fcku.it 2
TOTAL: 10 484
No colon-space in header
csiph-out.feeder.erje.net 367
usenet.blueworldhosting.com 17
TOTAL: 2 384
TOTAL: 5 1186

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.freedyn.net 32393 1360 27616 9 0 1 4%23:59:53
2news.bbs.geek.nz 54203 1196 27151 7 0 1 2%23:59:53
3xanadu-bbs 32198 1175 28034 15 0 0 3%23:59:53
4fu-berlin.de 27489 982 26507 0 0 0 3%23:59:48
5aioe 27378 540 23180 29 0 109 1%23:59:51
6usenet.pasdenom.info 37345 254 27609 1496 0 94 0%23:59:53
7news.redatomik.org 33866 105 27794 7 0 1 0%23:59:42
8au2pb 29036 89 28129 2 0 0 0%23:59:49
9erje 24314 67 24015 104 0 0 0%23:59:54
10xmission 37697 28 27885 2 0 0 0%23:59:52
11news.mixmin.net 29296 27 25354 0 0 1 0%23:59:45
12weretis.net 25788 23 25262 1 0 0 0%23:59:45
13news.fcku.it 5074 12 4302 0 0 0 0%22:20:18
14neva.ru 31427 11 25762 140 0 1 0%23:59:53
15news.swapon.de 2774 11 2422 4 0 0 0%23:51:38
16eternal-september 28993 11 23084 0 0 1 0%23:59:53
17bwh 23571 5 22153 1 0 0 0%23:59:54
TOTAL: 17 482842 5896 396259 1817 0 209 1%406:09:34
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.freedyn.net10.4 MB60.0 KB10.5 MB0.1 KB/s7.8 KB23:59:53
2xanadu-bbs9.7 MB52.8 KB9.8 MB0.1 KB/s8.4 KB23:59:53
3fu-berlin.de9.3 MB0.0 KB9.3 MB0.1 KB/s9.7 KB23:59:48
4news.bbs.geek.nz3.1 MB18.5 KB3.2 MB0.0 KB/s2.7 KB23:59:53
5aioe1.4 MB120.7 KB1.6 MB0.0 KB/s2.8 KB23:59:51
6usenet.pasdenom.info798.6 KB10.2 MB10.9 MB0.1 KB/s6.4 KB23:59:53
7news.redatomik.org308.4 KB44.8 KB353.2 KB0.0 KB/s3.2 KB23:59:42
8au2pb239.3 KB8.5 KB247.8 KB0.0 KB/s2.7 KB23:59:49
9erje202.2 KB283.5 KB485.8 KB0.0 KB/s2.8 KB23:59:54
10xmission70.7 KB3.8 KB74.5 KB0.0 KB/s2.5 KB23:59:52
11news.mixmin.net64.3 KB0.0 KB64.3 KB0.0 KB/s2.4 KB23:59:45
12weretis.net60.9 KB1.3 KB62.2 KB0.0 KB/s2.6 KB23:59:45
13eternal-september33.8 KB0.0 KB33.8 KB0.0 KB/s3.1 KB23:59:53
14neva.ru28.0 KB444.6 KB472.6 KB0.0 KB/s3.1 KB23:59:53
15news.fcku.it24.2 KB0.0 KB24.2 KB0.0 KB/s2.0 KB22:20:18
16news.swapon.de23.5 KB13.3 KB36.8 KB0.0 KB/s2.5 KB23:51:38
17bwh9.2 KB2.6 KB11.8 KB0.0 KB/s2.0 KB23:59:54
TOTAL: 1735.8 MB11.2 MB47.0 MB0.0 KB/s6.2 KB406:09:34
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1202.89.176.220 288 68164.1 KB 66 0 004:35:22
2mtrlpq2314w-lp140-01-845526598.dsl.bell.ca 48 1733.1 KB 15 0 000:38:17
3tempe0.bbox.io 20 511.4 KB 2 0 004:28:27
4dhcp-089-099-203-254.chello.nl 46 58.5 KB 2 0 021:28:41
568-185-181-64.dhcp.mdsn.wi.charter.com 9 48.2 KB 4 5 502:16:44
TOTAL: 5 411 99225.3 KB 89 5 5195:49:24

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1unresolved 522 68164.1 KB 66 0 038:55:47
2*.dsl.bell.ca 48 1733.1 KB 15 0 000:38:17
3*.chello.nl 46 58.5 KB 2 0 021:28:41
4*.bbox.io 20 511.4 KB 2 0 004:28:27
5*.dhcp.mdsn.wi.charter.com 9 48.2 KB 4 5 502:16:44
6*.nielsenmedia.com 5 00.0 KB 0 0 002:30:41
7*.157.22.98.dynamic.ip.windstream.net 1 00.0 KB 0 0 000:00:00
8*.tampfl.dsl-w.verizon.net 1 00.0 KB 0 0 001:02:05
TOTAL: 8 652 99225.3 KB 89 5 5195:49:24

NNRP auth users [Top 20]:

UserConn
moussa 288
ohlandl 5
TOTAL: 2 293

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
h62.159.22.98.dynamic.ip.windstream.net 1.650 3.386 0.000124:28:38
dhcp-089-099-203-254.chello.nl 3.686 0.822 0.00021:28:41
63.142.120.8 16.650 5.718 0.00020:14:31
162.212.88.221 0.307 0.302 0.00014:05:24
202.89.176.220 27.935 6.763 0.72104:35:22
tempe0.bbox.io 1.920 0.419 0.00004:28:27
challenger.nielsenmedia.com 0.344 0.125 0.00002:30:41
68-185-181-64.dhcp.mdsn.wi.charter.com 1.045 0.219 0.01402:16:44
pool-71-98-160-36.tampfl.dsl-w.verizon.net 0.167 0.024 0.00001:02:05
mtrlpq2314w-lp140-01-845526598.dsl.bell.ca 7.038 2.918 0.00000:38:17
196.52.22.25 0.487 0.640 0.00000:00:29
TOTAL: 11 61.229 21.336 0.735195:49:24

Curious NNRP server explorers [Top 20]:

SystemConn
63.142.120.8 228
challenger.nielsenmedia.com 5
162.212.88.221 4
196.52.22.25 2
h235.157.22.98.dynamic.ip.windstream.net 1
pool-71-98-160-36.tampfl.dsl-w.verizon.net 1
TOTAL: 6 241

NNRP client timeouts [Top 20]:

SystemConnPeer
dhcp-089-099-203-254.chello.nl 37 0
tempe0.bbox.io 8 0
challenger.nielsenmedia.com 5 0
68-185-181-64.dhcp.mdsn.wi.charter.com 3 0
pool-71-98-160-36.tampfl.dsl-w.verizon.net 2 0
h62.159.22.98.dynamic.ip.windstream.net 1 0
TOTAL: 6 56 0

Newsgroup request counts (by category):

CategoryCountPct
1comp 81 81.8%
2alt 11 11.1%
3bit 3 3.0%
4fr 1 1.0%
5rec 1 1.0%
6sci 1 1.0%
7soc 1 1.0%
TOTAL: 7 99100.0%

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

NewsgroupCount
1comp.os.vms 33
2comp.sys.ibm.ps2.hardware 18
3comp.sys.ibm.pc.games.action 9
4comp.os.os2.misc 5
5comp.os.os2.apps 5
6alt.happy.valley 4
7bit.listserv.ibm-main 3
8comp.ai.neural-nets 2
9comp.os.msdos.programmer 2
10comp.os.cpm 2
11soc.culture.quebec 1
12alt.support.diabetes 1
13comp.sys.ibm.pc.hardware.chips 1
14alt.life.sucks 1
15alt.home.repair 1
16fr.soc.politique 1
17sci.physics 1
18comp.arch.fpga 1
19alt.os.linux 1
20alt.russian.z1 1
21rec.boats 1
22comp.bbs.majorbbs 1
23alt.autos.toyota 1
24comp.answers 1
25comp.os.msdos.misc 1
26alt.atheism 1
TOTAL: 26 99