Daily Usenet report

Jul 17 04:15:02 -- Jul 18 04:15:02

Unknown entries from news log file:

First 11 / 11 lines (100.0%)

Jul 17 04:50:01 newsfeed pgpverify[30143]: pgpverify: verification failed
Jul 17 04:50:01 newsfeed controlchan[28638]: skipping newgroup y nl-admin@nic.surfnet.nl (pgpverify failed) in <1500257041.12396@news.a3.xs4all.nl>
Jul 17 12:13:44 newsfeed overchan[28640]: input line too long, skipping
Jul 17 13:10:02 newsfeed pgpverify[16801]: pgpverify: verification failed
Jul 17 13:46:13 newsfeed nnrpd[18071]: SERVER perl filter not defined
Jul 17 14:50:50 newsfeed nnrpd[20542]: SERVER perl filter not defined
Jul 17 15:20:55 newsfeed nnrpd[21681]: SERVER perl filter not defined
Jul 17 21:31:11 newsfeed nnrpd[3256]: SERVER perl filter not defined
Jul 17 22:07:21 newsfeed nnrpd[4666]: SERVER perl filter not defined
Jul 17 22:23:16 newsfeed nnrpd[5165]: SERVER perl filter not defined
Jul 17 22:25:22 newsfeed nnrpd[5230]: SERVER perl filter not defined

Log entries by program:

Program nameLines%LinesSize%Size
inn1236256 95.0%142.7 MB 94.6%
innfeed 46540 3.6%5.5 MB 3.6%
innd 13645 1.0%2.1 MB 1.4%
nnrpd 4766 0.4%506.1 KB 0.3%
controlchan 5 0.0%0.6 KB 0.0%
overchan 3 0.0%0.5 KB 0.0%
pgpverify 2 0.0%0.2 KB 0.0%
TOTAL: 71301217 100.0%150.8 MB100.0%

History cache:

ReasonCount%Count
Do not exist 1216927 95.3%
Negative hits 45367 3.6%
Positive hits 14187 1.1%
Cache misses 104 0.0%
TOTAL: 4 1276585 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:02.588 0.0%151 0.000 17.139 431.000
article cleanup00:00:18.137 0.0%1234585 0.011 0.015 0.019
article logging00:00:50.436 0.1%1235073 0.030 0.041 0.073
article parse00:31:13.197 2.2%109392060 0.011 0.017 0.027
article write00:12:11.857 0.8%1226955 0.391 0.596 3.010
artlog/artcncl00:00:00.003 0.0%143 0.000 0.021 0.500
artlog/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
data move00:01:21.740 0.1%117710868 0.000 0.001 0.001
hisgrep/artcncl00:00:00.851 0.0%150 0.000 5.673 173.500
hishave/artcncl00:00:00.325 0.0%151 0.000 2.152 8.222
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:58:17.729 4.0%1292268 0.224 2.707 7.612
history sync00:00:00.020 0.0%290 0.000 0.069 0.500
history write01:58:03.905 8.2%1231079 1.777 5.754 10.192
hiswrite/artcncl00:00:00.000 0.0%1 0.000 0.000 0.000
idle16:32:17.367 68.9%100551227 0.221 0.592 2.096
nntp read00:41:06.046 2.9%108548917 0.016 0.023 0.035
overview write00:00:06.808 0.0%1226955 0.003 0.006 0.010
perl filter02:29:02.698 10.3%1231079 6.196 7.264 8.235
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:02:19.663 0.2%2480230 0.040 0.056 0.075
TOTAL: 24:00:06.21423:27:13.370 97.7%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.203 0.0%71347 0.000 0.003 0.010
article prepare00:00:00.006 0.0%24506 0.000 0.000 0.050
article read00:00:30.253 0.0%6122 0.000 4.942 272.571
backlog stats00:00:00.154 0.0%225973 0.000 0.001 0.003
callbacks00:00:00.000 0.0%2 0.000 0.000 0.000
data read00:00:01.629 0.0%115183 0.003 0.014 0.028
data write00:00:10.898 0.0%102531 0.016 0.106 0.356
idle23:52:45.745 99.9%225973 91.090 380.425 712.161
status file00:00:13.352 0.0%16528 0.558 0.808 1.438
TOTAL: 23:53:54.50523:53:42.240100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:16.269 60.0%3036 0.000 5.359 51.778
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.172 0.6%6622 0.000 0.026 0.667
readart00:00:00.000 0.0%6 0.000 0.000 0.000
TOTAL: 00:00:27.11100:00:16.441 60.6%----

Control commands to INND:

CommandNumber
L 1
flush 27
flushlogs 2
go 2
logmode 2
mode 148
name 2
pause 2
paused 2
reload 2
reserve 2
TOTAL: 11 192

Control Channel:

SendernewgrouprmgroupOtherBad PGPDoItOK
newsmaster@carnet.hr000100
TOTAL000100

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1newsfeed.pionier.net.pl 717 12275471222545 2020 2982 99%255:21:10
2news.nask.pl 2 18000 4935 8440 4625 27%24:02:12
3news.icm.edu.pl 46 316 14 279 23 4%18:00:53
4localhost 8 7 7 0 0 100%00:00:00
TOTAL: 4 773 12458701227501 10739 7630 98%297:24:15
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1newsfeed.pionier.net.pl410.3 GB18.7 MB27.4 MB410.3 GB 99%351.1 KB
2news.nask.pl26.5 MB2.4 MB24.3 MB53.2 MB 49%5.7 KB
3news.icm.edu.pl435.9 KB0.0 KB1.1 MB1.5 MB 28%41.1 KB
4localhost10.1 KB0.0 KB0.0 KB10.1 KB100%1.4 KB
TOTAL: 4410.3 GB21.2 MB52.7 MB410.4 GB 99%348.4 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Jul 17 04:15:02 - 04:59:59 66950 5.5% 24.8121.6 GB 5.3%8406.22
Jul 17 05:00:00 - 05:59:59 80894 6.6% 22.4727.7 GB 6.8%8069.79
Jul 17 06:00:00 - 06:59:59 50129 4.1% 13.9216.5 GB 4.0%4801.32
Jul 17 07:00:00 - 07:59:59 35138 2.9% 9.7612.0 GB 2.9%3485.48
Jul 17 08:00:00 - 08:59:59 33729 2.7% 9.3710.5 GB 2.6%3062.91
Jul 17 09:00:00 - 09:59:59 35351 2.9% 9.8211.2 GB 2.7%3251.44
Jul 17 10:00:00 - 10:59:59 33637 2.7% 9.3411.2 GB 2.7%3255.80
Jul 17 11:00:00 - 11:59:59 31012 2.5% 8.6110.9 GB 2.7%3168.51
Jul 17 12:00:00 - 12:59:59 33234 2.7% 9.2312.3 GB 3.0%3577.02
Jul 17 13:00:00 - 13:59:59 36386 3.0% 10.1112.9 GB 3.1%3750.76
Jul 17 14:00:00 - 14:59:59 35354 2.9% 9.8211.3 GB 2.8%3299.53
Jul 17 15:00:00 - 15:59:59 42028 3.4% 11.6714.6 GB 3.6%4262.98
Jul 17 16:00:00 - 16:59:59 39248 3.2% 10.9014.4 GB 3.5%4194.91
Jul 17 17:00:00 - 17:59:59 38962 3.2% 10.8212.8 GB 3.1%3719.88
Jul 17 18:00:00 - 18:59:59 66803 5.4% 18.5622.1 GB 5.4%6450.12
Jul 17 19:00:00 - 19:59:59 74520 6.1% 20.7024.1 GB 5.9%7026.47
Jul 17 20:00:00 - 20:59:59 72999 5.9% 20.2823.2 GB 5.7%6757.15
Jul 17 21:00:00 - 21:59:59 36426 3.0% 10.1211.3 GB 2.8%3294.98
Jul 17 22:00:00 - 22:59:59 30712 2.5% 8.539.9 GB 2.4%2869.30
Jul 17 23:00:00 - 23:59:59 26921 2.2% 7.489.7 GB 2.4%2839.45
Jul 18 00:00:00 - 00:59:59 67323 5.5% 18.7022.1 GB 5.4%6437.36
Jul 18 01:00:00 - 01:59:59 87722 7.1% 24.3729.4 GB 7.2%8552.51
Jul 18 02:00:00 - 02:59:59 73611 6.0% 20.4525.8 GB 6.3%7528.21
Jul 18 03:00:00 - 03:59:59 73961 6.0% 20.5424.9 GB 6.1%7238.25
Jul 18 04:00:00 - 04:15:02 24946 2.0% 27.667.9 GB 1.9%9175.05
TOTAL: 24:00:00 1227996 100.0% 14.21410.2 GB 100.0%4978.87
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1news.nask.pl 4674 10 0 877 1 0 0 0 3786
2newsfeed.pionier.net.pl 3420 241 0 2628 3 0 0 0 548
3news.icm.edu.pl 23 0 0 0 0 0 0 0 23
TOTAL: 3 8117 251 0 3505 4 0 0 0 4357

Unwanted newsgroups [Top 20]:

NewsgroupCount
uk.railway 184
comp.mobile.android 21
it.comp.os.win.windows10 13
uk.net.providers.gradwell 8
uk.rec.cycling.moderated 7
it.tlc.cellulari.android 4
nl.comp.os.linux.techniek 3
comp.mobile.ipad 3
de.comm.software.mailreader 2
comp.sys.raspberry-pi 2
hr.ponuda.hardver.komponente 1
de.comp.lang.php 1
hr.alt.cellular.gsm.android 1
alt.sex.telephones 1
TOTAL: 14 251

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

GroupsCount
pl.praca.oferowana 3
bit.listserv.catholic 1
TOTAL: 2 4

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 3547
Binary in non-binary group 194
EMP (phl) 51
Scoring filter (8) 34
Scoring filter (9) 18
HTML post 11
Too many newsgroups 4
Scoring filter (10) 3
Poison newsgroup 3
Scoring filter (11) 2
Scoring filter (12) 1
Scoring filter (14) 1
TOTAL: 12 3869

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
newsfeed.pionier.net.pl 438
news.nask.pl 50
TOTAL: 2 488
TOTAL: 1 488

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1panorama 49844 628 21416 257 3 49306 1%23:59:57
2icm 34911 126 21126 4562 0 0 0%23:59:49
3poznan 6880 46 4763 25 0 0 0%23:59:57
4nask 16364 4 9963 0 0 0 0%23:59:57
5okapi 0 0 0 0 0 2276 0%23:57:50
TOTAL: 5 107999 804 57268 4844 3 51582 0%119:57:30
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1icm9.8 MB1.7 GB1.7 GB20.6 KB/s380.2 KB23:59:49
2panorama1.9 MB865.8 KB2.7 MB0.0 KB/s3.1 KB23:59:57
3poznan186.4 KB80.1 KB266.5 KB0.0 KB/s3.8 KB23:59:57
4nask10.7 KB0.0 KB10.7 KB0.0 KB/s2.7 KB23:59:57
5okapi0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:50
TOTAL: 511.9 MB1.7 GB1.7 GB4.1 KB/s316.1 KB119:57:30
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1web.man.lodz.pl 288 65.3 KB 3 0 000:00:20
2isvcs01.man.lodz.pl 7 00.0 KB 0 7 000:00:00
TOTAL: 2 295 65.3 KB 3 7 000:00:26

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.man.lodz.pl 679 65.3 KB 3 7 000:00:26
TOTAL: 1 679 65.3 KB 3 7 000:00:26

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
web.man.lodz.pl 1.116 5.080 0.00000:00:20
mon.man.lodz.pl 1.068 4.644 0.00000:00:03
david.man.lodz.pl 0.360 1.660 0.00000:00:01
isvcs01.man.lodz.pl 0.056 0.144 0.00000:00:00
TOTAL: 4 2.600 11.528 0.00000:00:26

Curious NNRP server explorers [Top 20]:

SystemConn
mon.man.lodz.pl 288
david.man.lodz.pl 96
TOTAL: 2 384

Newsgroup request counts (by category):

CategoryCountPct
1pl 6100.0%
TOTAL: 1 6100.0%

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

NewsgroupCount
1pl.comp.pecet 4
2pl.comp.os.ms-windows.winnt 2
TOTAL: 2 6