Daily Usenet report for paganini.linuxd.org

May 2 00:00:04 -- May 3 00:00:01

Unknown entries from news log file:

First 5 / 5 lines (100.0%)

May 2 18:30:53 paganini overchan[25718]: input line too long, skipping
May 2 18:33:41 paganini overchan[25718]: input line too long, skipping
May 2 21:19:13 paganini overchan[25718]: input line too long, skipping
May 2 23:37:51 paganini overchan[25718]: input line too long, skipping
May 3 00:00:01 paganini overchan[5042]: overchan is running while innd is creating overview data (you can ignore this message if you are running makehistory -F)

Log entries by program:

Program nameLines%LinesSize%Size
innfeed 115678 47.5%14.3 MB 43.2%
nnrpd 68758 28.3%7.9 MB 23.9%
inn 40103 16.5%8.4 MB 25.4%
innd 18644 7.7%2.5 MB 7.4%
nocem 95 0.0%14.4 KB 0.0%
overchan 6 0.0%0.9 KB 0.0%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 7 243285 100.0%33.2 MB100.0%

History cache:

ReasonCount%Count
Positive hits 113353 49.6%
Negative hits 75932 33.2%
Do not exist 38937 17.0%
Cache misses 388 0.2%
TOTAL: 4 228610 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:02.520 0.0%487 0.000 5.175 69.167
article cleanup00:00:00.265 0.0%39205 0.000 0.007 0.027
article logging00:00:00.510 0.0%39650 0.000 0.013 0.385
article parse00:00:01.084 0.0%89913 0.000 0.012 0.030
article write00:00:51.500 0.1%21468 0.178 2.399 13.397
artlog/artcncl00:00:00.004 0.0%484 0.000 0.008 0.143
data move00:00:00.206 0.0%246512 0.000 0.001 0.013
hisgrep/artcncl00:00:00.027 0.0%487 0.000 0.055 0.111
hishave/artcncl00:00:00.006 0.0%487 0.000 0.012 0.056
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:10.199 0.0%229854 0.015 0.044 0.411
history sync00:00:00.086 0.0%398 0.000 0.216 13.333
history write00:00:32.761 0.0%39178 0.038 0.836 3.193
hiswrite/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
idle23:57:02.196 99.7%246215 193.821 350.191 913.457
nntp read00:00:01.829 0.0%254873 0.001 0.007 0.014
overview write00:00:23.475 0.0%21468 0.000 1.093 6.724
perl filter00:01:24.326 0.1%39110 1.028 2.156 4.739
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:00:01.229 0.0%64559 0.002 0.019 0.045
TOTAL: 24:01:05.64424:00:32.223100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.097 0.0%56885 0.000 0.002 0.011
article prepare00:00:00.002 0.0%18328 0.000 0.000 0.008
article read00:00:01.102 0.0%4161 0.000 0.265 5.043
backlog stats00:00:00.230 0.0%316870 0.000 0.001 0.003
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:01.406 0.0%169775 0.002 0.008 0.020
data write00:00:02.791 0.0%148484 0.007 0.019 0.034
idle23:41:25.580 99.2%316870 30.886 269.150 457.522
status file00:11:22.494 0.8%48464 8.554 14.082 25.690
TOTAL: 23:53:06.36423:52:53.702100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle06:52:44.676 99.9%69596 37.305 355.835600644.667
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:01.371 0.0%141408 0.000 0.010 0.062
readart00:00:00.000 0.0%18 0.000 0.000 0.000
TOTAL: 06:53:07.65806:52:46.047 99.9%----

Control commands to INND:

CommandNumber
L 1
flush 6
flushlogs 2
go 2
logmode 2
mode 149
name 2
pause 2
paused 2
reload 2
reserve 2
TOTAL: 11 172

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1linuxd-out.news.weretis.net 5 46987 18716 26016 2255 39%48:34:24
2newsfeed.neva.ru 143 82852 2384 65094 15374 2%71:57:26
3news.fcku.it 2 9249 440 8624 185 4%26:20:32
4nntp.pasdenom.info 4 31802 95 31625 82 0%42:02:15
5localhost 25 0 0 0 0 0%00:00:00
TOTAL: 5 179 170890 21635 131359 17896 12%188:54:37
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1linuxd-out.news.weretis.net57.5 MB62.5 KB13.8 MB71.5 MB 80%3.5 KB
2newsfeed.neva.ru6.2 MB41.8 KB136.0 MB142.3 MB 4%8.2 KB
3news.fcku.it2.2 MB0.0 KB760.0 KB3.0 MB 74%4.8 KB
4nntp.pasdenom.info228.8 KB0.0 KB926.0 KB1.1 MB 19%6.5 KB
5localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 566.2 MB104.3 KB151.5 MB217.8 MB 30%5.6 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
May 2 00:00:04 - 00:59:59 846 3.9% 0.242.6 MB 4.0% 0.75
May 2 01:00:00 - 01:59:59 606 2.8% 0.171.7 MB 2.6% 0.49
May 2 02:00:00 - 02:59:59 497 2.3% 0.141.4 MB 2.1% 0.39
May 2 03:00:00 - 03:59:59 530 2.5% 0.151.7 MB 2.6% 0.48
May 2 04:00:00 - 04:59:59 549 2.6% 0.152.2 MB 3.4% 0.63
May 2 05:00:00 - 05:59:59 456 2.1% 0.131.6 MB 2.4% 0.45
May 2 06:00:00 - 06:59:59 728 3.4% 0.203.4 MB 5.2% 0.96
May 2 07:00:00 - 07:59:59 516 2.4% 0.141.5 MB 2.4% 0.44
May 2 08:00:00 - 08:59:59 600 2.8% 0.171.9 MB 3.0% 0.55
May 2 09:00:00 - 09:59:59 778 3.6% 0.222.3 MB 3.5% 0.64
May 2 10:00:00 - 10:59:59 885 4.1% 0.252.7 MB 4.2% 0.78
May 2 11:00:00 - 11:59:59 912 4.2% 0.253.0 MB 4.5% 0.84
May 2 12:00:00 - 12:59:59 890 4.1% 0.252.5 MB 3.8% 0.71
May 2 13:00:00 - 13:59:59 962 4.5% 0.272.5 MB 3.9% 0.72
May 2 14:00:00 - 14:59:59 1057 4.9% 0.293.0 MB 4.6% 0.87
May 2 15:00:00 - 15:59:59 1149 5.4% 0.323.1 MB 4.7% 0.88
May 2 16:00:00 - 16:59:59 1139 5.3% 0.323.2 MB 5.0% 0.92
May 2 17:00:00 - 17:59:59 1251 5.8% 0.353.5 MB 5.4% 1.01
May 2 18:00:00 - 18:59:59 1228 5.7% 0.343.5 MB 5.3% 1.00
May 2 19:00:00 - 19:59:59 1326 6.2% 0.374.5 MB 6.8% 1.28
May 2 20:00:00 - 20:59:59 1261 5.9% 0.353.3 MB 5.0% 0.93
May 2 21:00:00 - 21:59:59 1151 5.4% 0.323.1 MB 4.8% 0.89
May 2 22:00:00 - 22:59:59 1153 5.4% 0.323.8 MB 5.8% 1.08
May 2 23:00:00 - 23:59:59 986 4.6% 0.273.4 MB 5.2% 0.97
May 3 00:00:00 - 00:00:01 3 0.0% 3.0026.8 KB 0.0% 26.80
TOTAL: 23:59:57 21459 100.0% 0.2565.6 MB 100.0% 0.78
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1newsfeed.neva.ru 15220 460 0 6 0 0 0 014754
2linuxd-out.news.weretis.net 2685 548 0 21 0 0 0 0 2116
3news.fcku.it 173 2 0 0 0 0 0 0 171
4nntp.pasdenom.info 80 0 0 0 0 68 0 0 12
TOTAL: 4 18158 1010 0 27 0 68 0 017053

Unwanted newsgroups [Top 20]:

NewsgroupCount
lada.talk 152
ut.test 111
lada.auto 62
alt.windows7.general 48
mpc.lists.freebsd.ports.bugs 44
it.comp.os.win.windows10 33
alt.survival 31
it.annunci.immobiliari 31
it.annunci.commerciali 30
it-alt.sport.calcio.juventus 28
it.annunci.varie 25
mozilla.support.firefox 20
mozilla.dev.security.policy 19
mpc.lists.nanog 18
mozilla.support.seamonkey 18
spline.eisfair 18
lada.commerce 15
gmane.linux.alsa.devel 15
lada.movies 15
gmane.comp.gis.openstreetmap.tagging 14
TOTAL: 114 1010

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 14558
EMP (phn path) 1672
EMP (phl) 158
EMP (phn nph) 75
Too many newsgroups 53
User-issued cancel 36
Binary Payload 27
Binary: non-binary distribution 22
HTML post 3
Too many newsgroups (low_xpost) 2
Too many newsgroups (meow) 1
User-issued spam cancel 1
UUencoded exe 1
TOTAL: 13 16609

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
linuxd-out.news.weretis.net 426
newsfeed.neva.ru 18
TOTAL: 2 444
TOTAL: 1 444

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.fcku.it 28619 1486 17411 2212 0 105 5%23:59:50
2nntp.pasdenom.info 26318 433 21413 140 0 20402 1%23:57:45
3weretis.net 2892 123 2637 0 0 7 4%23:58:34
4eternal-september 23324 48 18370 0 0 138 0%23:59:52
5neva.ru 27916 45 18940 112 0 232 0%23:59:45
6news.stack.nl 2855 0 0 0 0 24286 0%23:59:52
7news.killfile.org 2836 0 0 0 0 24294 0%23:59:52
8news.netfront.net 2767 0 0 0 0 24185 0%23:59:51
9news.mixmin.net 0 0 0 0 0 0 0%00:10:00
10news.albasani.net 2852 0 0 0 0 23460 0%23:59:52
11etla.org 0 0 0 0 0 21459 0%23:59:52
12vc89.vc.panix.com 2828 0 0 0 0 24286 0%23:59:52
TOTAL: 12 123207 2135 78771 2464 0 162854 1%264:04:57
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.fcku.it4.2 MB6.8 MB11.0 MB0.1 KB/s3.0 KB23:59:50
2nntp.pasdenom.info1.6 MB379.3 KB2.0 MB0.0 KB/s3.5 KB23:57:45
3weretis.net259.8 KB0.0 KB259.8 KB0.0 KB/s2.1 KB23:58:34
4eternal-september166.4 KB0.0 KB166.4 KB0.0 KB/s3.5 KB23:59:52
5neva.ru133.6 KB332.9 KB466.6 KB0.0 KB/s3.0 KB23:59:45
6news.stack.nl0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:52
7news.killfile.org0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:52
8news.netfront.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:51
9news.mixmin.net0.0 KB0.0 KB0.0 KB0.0 KB/s000:10:00
10news.albasani.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:52
11etla.org0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:52
12vc89.vc.panix.com0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:52
TOTAL: 126.3 MB7.5 MB13.8 MB0.0 KB/s3.1 KB264:04:57
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1challenger.nielsenmedia.com 14 1327.1 KB 10 0 005:55:35
2dslb-188-099-023-198.188.099.pools.vodafone-ip.de 123 510.9 KB 5 0 000:57:31
TOTAL: 2 137 1838.1 KB 15 0 006:53:07

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.nielsenmedia.com 14 1327.1 KB 10 0 005:55:35
2*.188.099.pools.vodafone-ip.de 123 510.9 KB 5 0 000:57:31
TOTAL: 2 137 1838.1 KB 15 0 006:53:07

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
challenger.nielsenmedia.com 0.904 0.088 0.00005:55:35
dslb-188-099-023-198.188.099.pools.vodafone-ip.de 13.168 3.524 0.00000:57:31
TOTAL: 2 14.072 3.612 0.00006:53:07

NNRP client timeouts [Top 20]:

SystemConnPeer
challenger.nielsenmedia.com 10 0
TOTAL: 1 10 0

Newsgroup request counts (by category):

CategoryCountPct
1comp 14 73.7%
2de 3 15.8%
3control 1 5.3%
4alt 1 5.3%
TOTAL: 4 19100.0%

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

NewsgroupCount
1comp.lang.awk 14
2de.soc.politik.misc 1
3alt.test 1
4control.cancel 1
5de.talk.jokes 1
6de.alt.fan.aldi 1
TOTAL: 6 19