Daily Usenet report

Oct 5 04:15:03 -- Oct 6 04:15:03

Unknown entries from news log file:

First 22 / 22 lines (100.0%)

Oct 5 07:51:59 newsfeed overchan[9913]: input line too long, skipping
Oct 5 07:53:21 newsfeed overchan[9913]: input line too long, skipping
Oct 5 07:53:46 newsfeed overchan[9913]: input line too long, skipping
Oct 5 08:42:44 newsfeed nnrpd[21086]: SERVER perl filter not defined
Oct 5 13:38:05 newsfeed overchan[9913]: input line too long, skipping
Oct 5 13:41:48 newsfeed overchan[9913]: input line too long, skipping
Oct 5 13:41:48 newsfeed overchan[9913]: input line too long, skipping
Oct 5 13:53:35 newsfeed nnrpd[32592]: SERVER perl filter not defined
Oct 5 16:10:08 newsfeed nnrpd[5360]: SERVER perl filter not defined
Oct 5 17:38:16 newsfeed overchan[9913]: input line too long, skipping
Oct 5 17:39:37 newsfeed overchan[9913]: input line too long, skipping
Oct 5 17:40:10 newsfeed overchan[9913]: input line too long, skipping
Oct 5 17:56:38 newsfeed overchan[9913]: input line too long, skipping
Oct 5 18:03:36 newsfeed overchan[9913]: input line too long, skipping
Oct 5 20:04:47 newsfeed overchan[9913]: input line too long, skipping
Oct 5 20:26:24 newsfeed overchan[9913]: input line too long, skipping
Oct 5 21:27:11 newsfeed overchan[9913]: input line too long, skipping
Oct 5 22:00:03 newsfeed pgpverify[18705]: pgpverify: verification failed
Oct 5 23:47:06 newsfeed overchan[9913]: input line too long, skipping
Oct 6 00:45:52 newsfeed overchan[9913]: input line too long, skipping
Oct 6 00:47:52 newsfeed overchan[9913]: input line too long, skipping
Oct 6 00:48:16 newsfeed overchan[9913]: input line too long, skipping

Log entries by program:

Program nameLines%LinesSize%Size
inn2164044 97.1%252.5 MB 96.8%
innfeed 44362 2.0%5.3 MB 2.0%
innd 15875 0.7%2.6 MB 1.0%
nnrpd 4949 0.2%530.3 KB 0.2%
overchan 19 0.0%3.2 KB 0.0%
controlchan 4 0.0%0.5 KB 0.0%
pgpverify 1 0.0%0.2 KB 0.0%
TOTAL: 72229254 100.0%260.9 MB100.0%

History cache:

ReasonCount%Count
Do not exist 2141615 88.7%
Positive hits 170083 7.0%
Negative hits 101109 4.2%
Cache misses 1808 0.1%
TOTAL: 4 2414615 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:01.986 0.0%74 0.000 26.838 731.000
article cleanup00:00:32.052 0.0%2165500 0.010 0.015 0.020
article logging00:01:58.352 0.1%2166125 0.040 0.055 0.080
article parse00:52:17.953 3.6%82482753 0.023 0.038 0.055
article write00:20:17.411 1.4%2150893 0.262 0.566 0.873
artlog/artcncl00:00:00.006 0.0%74 0.000 0.081 1.000
data move00:05:08.923 0.4%95676562 0.002 0.003 0.006
hisgrep/artcncl00:00:00.247 0.0%73 0.000 3.384 64.000
hishave/artcncl00:00:00.096 0.0%74 0.000 1.297 14.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup02:55:10.504 12.2%2427968 0.707 4.329 9.192
history sync00:00:00.021 0.0%290 0.000 0.072 1.000
history write04:05:07.253 17.0%2153121 2.908 6.831 11.695
hiswrite/artcncl00:00:00.001 0.0%1 1.000 1.000 1.000
idle08:56:35.541 37.3%54877579 0.246 0.587 1.079
nntp read01:19:59.478 5.6%80943265 0.045 0.059 0.072
overview write00:00:13.194 0.0%2150893 0.004 0.006 0.009
perl filter04:54:47.385 20.5%2153117 5.120 8.215 10.388
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:05:33.510 0.4%4527775 0.059 0.074 0.094
TOTAL: 24:00:02.80523:37:43.913 98.5%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:01.578 0.0%493993 0.000 0.003 0.013
article prepare00:00:00.086 0.0%225992 0.000 0.000 0.004
article read00:03:50.549 0.3%51625 0.404 4.466 94.600
backlog stats00:00:01.758 0.0%1668258 0.000 0.001 0.002
callbacks00:00:00.000 0.0%1 0.000 0.000 0.000
data read00:00:21.925 0.0%865872 0.017 0.025 0.040
data write00:03:29.744 0.2%861400 0.075 0.243 0.572
idle23:41:29.936 99.4%1668258 10.168 51.125 394.845
status file00:00:25.240 0.0%15787 0.795 1.599 10.767
TOTAL: 23:50:39.55723:49:40.816 99.9%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:26:10.306 98.8%3155 0.000 497.720 35648.222
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.539 0.0%7068 0.000 0.076 2.421
readart00:00:01.039 0.1%66 0.000 15.742 55.714
TOTAL: 00:26:28.94200:26:11.884 98.9%----

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
moderator@dana.de000100
TOTAL000100

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1newsfeed.pionier.net.pl 629 21451322139433 2014 3685 99%521:55:03
2news.nask.pl 4 180395 7945 161477 10973 4%26:07:05
3news.icm.edu.pl 40 335 136 139 60 40%16:24:16
4localhost 4 3 3 0 0 100%00:00:00
TOTAL: 4 677 23258652147517 163630 14718 92%564:26:24
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1newsfeed.pionier.net.pl716.2 GB807.7 MB816.1 MB717.8 GB 99%351.2 KB
2news.nask.pl2.3 GB4.7 GB4.7 GB11.6 GB 19%645.0 KB
3news.icm.edu.pl2.8 MB170.0 KB2.5 MB5.5 MB 51%28.8 KB
4localhost4.5 KB0.0 KB0.0 KB4.5 KB100%1.5 KB
TOTAL: 4718.5 GB5.5 GB5.5 GB729.5 GB 98%353.8 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Oct 5 04:15:03 - 04:59:59 69026 3.2% 25.5928.8 GB 4.0%11211.87
Oct 5 05:00:00 - 05:59:59 112922 5.3% 31.3737.9 GB 5.3%11053.45
Oct 5 06:00:00 - 06:59:59 94883 4.4% 26.3637.5 GB 5.2%10919.20
Oct 5 07:00:00 - 07:59:59 81428 3.8% 22.6231.9 GB 4.4%9300.63
Oct 5 08:00:00 - 08:59:59 86989 4.0% 24.1634.1 GB 4.7%9940.42
Oct 5 09:00:00 - 09:59:59 101520 4.7% 28.2034.3 GB 4.8%9991.61
Oct 5 10:00:00 - 10:59:59 119017 5.5% 33.0631.9 GB 4.4%9285.10
Oct 5 11:00:00 - 11:59:59 75028 3.5% 20.8422.3 GB 3.1%6497.30
Oct 5 12:00:00 - 12:59:59 81218 3.8% 22.5628.5 GB 4.0%8295.85
Oct 5 13:00:00 - 13:59:59 90392 4.2% 25.1131.2 GB 4.3%9086.20
Oct 5 14:00:00 - 14:59:59 67599 3.1% 18.7818.8 GB 2.6%5480.63
Oct 5 15:00:00 - 15:59:59 90260 4.2% 25.0730.7 GB 4.3%8927.86
Oct 5 16:00:00 - 16:59:59 66834 3.1% 18.5723.6 GB 3.3%6860.37
Oct 5 17:00:00 - 17:59:59 73617 3.4% 20.4525.3 GB 3.5%7364.30
Oct 5 18:00:00 - 18:59:59 115583 5.4% 32.1139.5 GB 5.5%11504.71
Oct 5 19:00:00 - 19:59:59 120278 5.6% 33.4139.7 GB 5.5%11571.97
Oct 5 20:00:00 - 20:59:59 115104 5.4% 31.9733.6 GB 4.7%9786.57
Oct 5 21:00:00 - 21:59:59 80024 3.7% 22.2325.2 GB 3.5%7354.39
Oct 5 22:00:00 - 22:59:59 74336 3.5% 20.6524.3 GB 3.4%7088.13
Oct 5 23:00:00 - 23:59:59 93458 4.3% 25.9621.4 GB 3.0%6245.49
Oct 6 00:00:00 - 00:59:59 60008 2.8% 16.6720.7 GB 2.9%6042.87
Oct 6 01:00:00 - 01:59:59 88529 4.1% 24.5929.9 GB 4.2%8717.53
Oct 6 02:00:00 - 02:59:59 96975 4.5% 26.9433.7 GB 4.7%9825.13
Oct 6 03:00:00 - 03:59:59 78263 3.6% 21.7428.2 GB 3.9%8218.45
Oct 6 04:00:00 - 04:15:03 15412 0.7% 17.075.5 GB 0.8%6333.37
TOTAL: 24:00:00 2148703 100.0% 24.87718.7 GB 100.0%8722.76
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1news.nask.pl 11028 7 0 9045 7 0 0 0 1969
2newsfeed.pionier.net.pl 4167 236 0 3367 9 0 0 0 555
3news.icm.edu.pl 72 0 0 9 0 0 0 0 63
TOTAL: 3 15267 243 0 12421 16 0 0 0 2587

Unwanted newsgroups [Top 20]:

NewsgroupCount
uk.railway 138
it.comp.os.win.windows10 41
comp.sys.raspberry-pi 19
nl.comp.sys.android 13
it.tlc.cellulari.android 11
comp.mobile.android 9
it.comp.os.win.windows7 6
uk.rec.cycling.moderated 2
de.comm.provider.telefonie 2
it.comp.os.linux.ubuntu 1
it.comp.dotnet 1
TOTAL: 11 243

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

GroupsCount
pl.praca.oferowana 6
pl.sci.matematyka 5
courts.usa.federal.supreme 3
clari.usa.law.supreme 1
bit.listserv.catholic 1
TOTAL: 5 16

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 1835
Binary in non-binary group 83
Scoring filter (8) 21
Scoring filter (9) 7
Scoring filter (16) 4
Too many newsgroups 4
Scoring filter (10) 2
Scoring filter (18) 2
Scoring filter (11) 2
Scoring filter (12) 1
Angle-bracket bot 1
Scoring filter (15) 1
TOTAL: 12 1963

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Article posted in the future
newsfeed.pionier.net.pl 4
TOTAL: 1 4
Including strange strings
newsfeed.pionier.net.pl 481
news.nask.pl 134
news.icm.edu.pl 5
TOTAL: 3 620
TOTAL: 2 624

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1nask 310950 32385 175981 2712 0 4518 10%23:59:58
2panorama 294729 5573 261499 930 4 222754 1%23:59:58
3poznan 5883 16 4306 22 0 0 0%23:52:24
4icm 249276 16 209899 15400 0 1 0%23:59:58
5okapi 0 0 0 0 0 920 0%23:57:51
TOTAL: 5 860838 37990 651685 19064 4 228193 4%119:50:09
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1nask19.8 GB1.7 GB21.5 GB261.2 KB/s642.9 KB23:59:58
2panorama2.4 GB19.7 MB2.4 GB29.4 KB/s390.5 KB23:59:58
3icm3.2 MB9.3 GB9.3 GB113.1 KB/s633.9 KB23:59:58
4poznan70.0 KB94.3 KB164.2 KB0.0 KB/s4.3 KB23:52:24
5okapi0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:51
TOTAL: 522.3 GB11.0 GB33.3 GB80.8 KB/s611.3 KB119:50:09
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1web.man.lodz.pl 288 4247.1 KB 17 0 000:00:27
2252-rev220.sejnet.pl 7 2431.7 KB 8 0 100:25:53
3isvcs01.man.lodz.pl 3 00.0 KB 0 3 000:00:00
TOTAL: 3 298 6678.8 KB 25 3 100:26:28

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.man.lodz.pl 579 4247.1 KB 17 3 000:00:33
2*.sejnet.pl 7 2431.7 KB 8 0 100:25:53
3unresolved 96 00.0 KB 0 0 000:00:01
TOTAL: 3 682 6678.8 KB 25 3 100:26:28

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
252-rev220.sejnet.pl 0.120 0.124 0.00000:25:53
web.man.lodz.pl 1.588 4.940 0.00000:00:27
mon.man.lodz.pl 1.476 4.676 0.00000:00:04
212.51.192.185 0.460 1.548 0.00000:00:01
isvcs01.man.lodz.pl 0.036 0.072 0.00000:00:00
TOTAL: 5 3.680 11.360 0.00000:26:28

Curious NNRP server explorers [Top 20]:

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

Newsgroup request counts (by category):

CategoryCountPct
1pl 42 63.6%
2lodz 15 22.7%
3lodman 9 13.6%
TOTAL: 3 66100.0%

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

NewsgroupCount
1pl.comp.os.ms-windows.winnt 26
2pl.comp.pecet 16
3lodz.test 13
4lodman.test 6
5lodman.info 3
6lodz.ogloszenia 2
TOTAL: 6 66