Daily Usenet report

Aug 21 04:15:02 -- Aug 22 04:15:02

Unknown entries from news log file:

First 21 / 21 lines (100.0%)

Aug 21 04:21:32 newsfeed nnrpd[26146]: david.man.lodz.pl rejected Expiring process 26079
Aug 21 09:20:23 newsfeed overchan[25792]: input line too long, skipping
Aug 21 10:29:23 newsfeed nnrpd[8292]: SERVER perl filter not defined
Aug 21 10:30:57 newsfeed nnrpd[8348]: SERVER perl filter not defined
Aug 21 10:31:12 newsfeed nnrpd[8354]: SERVER perl filter not defined
Aug 21 14:14:45 newsfeed overchan[25792]: input line too long, skipping
Aug 21 14:50:58 newsfeed overchan[25792]: input line too long, skipping
Aug 21 15:27:33 newsfeed overchan[25792]: input line too long, skipping
Aug 21 15:47:15 newsfeed overchan[25792]: input line too long, skipping
Aug 21 17:09:29 newsfeed nnrpd[23172]: SERVER perl filter not defined
Aug 21 17:12:08 newsfeed nnrpd[23246]: SERVER perl filter not defined
Aug 21 17:13:51 newsfeed nnrpd[23421]: SERVER perl filter not defined
Aug 21 18:08:20 newsfeed overchan[25792]: input line too long, skipping
Aug 21 18:13:43 newsfeed overchan[25792]: input line too long, skipping
Aug 21 18:34:34 newsfeed overchan[25792]: input line too long, skipping
Aug 21 18:58:17 newsfeed overchan[25792]: input line too long, skipping
Aug 21 20:09:01 newsfeed overchan[25792]: input line too long, skipping
Aug 21 20:16:10 newsfeed overchan[25792]: input line too long, skipping
Aug 21 20:20:30 newsfeed overchan[25792]: input line too long, skipping
Aug 21 21:29:56 newsfeed overchan[25792]: input line too long, skipping
Aug 22 00:50:02 newsfeed overchan[25792]: input line too long, skipping

Log entries by program:

Program nameLines%LinesSize%Size
inn2601781 97.6%299.9 MB 97.3%
innfeed 39907 1.5%4.7 MB 1.5%
innd 20583 0.8%3.3 MB 1.1%
nnrpd 4808 0.2%506.7 KB 0.2%
overchan 15 0.0%2.3 KB 0.0%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 62667095 100.0%308.3 MB100.0%

History cache:

ReasonCount%Count
Do not exist 2578990 93.4%
Positive hits 93202 3.4%
Negative hits 88118 3.2%
Cache misses 1308 0.0%
TOTAL: 4 2761618 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:03.670 0.0%176 0.000 20.852 159.500
article cleanup00:00:29.355 0.0%2599594 0.008 0.011 0.015
article logging00:01:49.317 0.1%2600116 0.029 0.042 0.237
article parse00:35:12.455 2.4%102816927 0.013 0.021 0.036
article write00:15:30.266 1.1%2593987 0.188 0.359 0.808
artlog/artcncl00:00:00.009 0.0%171 0.000 0.053 1.000
artlog/artparse00:00:00.000 0.0%1 0.000 0.000 0.000
data move00:02:08.039 0.1%117730062 0.000 0.001 0.002
hisgrep/artcncl00:00:00.952 0.0%162 0.000 5.877 44.600
hishave/artcncl00:00:00.005 0.0%176 0.000 0.028 1.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:12:45.699 0.9%2780193 0.157 0.275 0.427
history sync00:00:00.023 0.0%290 0.000 0.079 1.000
history write01:24:38.194 5.9%2596077 0.353 1.956 9.317
hiswrite/artcncl00:00:00.018 0.0%14 0.000 1.286 2.000
idle16:26:07.363 68.5%85051113 0.359 0.696 2.450
nntp read00:52:56.476 3.7%101008376 0.021 0.031 0.046
overview write00:00:11.575 0.0%2593987 0.003 0.004 0.007
perl filter03:39:18.729 15.2%2596067 3.046 5.069 8.350
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:04:21.807 0.3%5422367 0.036 0.048 0.069
TOTAL: 24:00:03.39923:35:33.952 98.3%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:01.049 0.0%465125 0.000 0.002 0.006
article prepare00:00:00.119 0.0%597074 0.000 0.000 0.003
article read00:04:49.839 0.3%136336 0.211 2.126 27.930
backlog stats00:00:02.030 0.0%2358416 0.000 0.001 0.002
callbacks00:00:00.000 0.0%2 0.000 0.000 0.000
data read00:00:13.890 0.0%950784 0.007 0.015 0.025
data write00:05:53.598 0.4%1419287 0.043 0.249 0.521
idle23:38:25.604 99.1%2358416 6.427 36.086 574.468
status file00:00:15.567 0.0%16559 0.429 0.940 12.939
TOTAL: 23:50:36.09123:49:41.696 99.9%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:24.195 68.9%3069 0.000 7.884 9722.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.202 0.6%6769 0.000 0.030 0.526
readart00:00:00.004 0.0%44 0.000 0.091 0.500
TOTAL: 00:00:35.12400:00:24.401 69.5%----

Control commands to INND:

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

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1newsfeed.pionier.net.pl 1260 25959012588957 4339 2605 99%388:41:20
2news.nask.pl 2 94672 6294 85396 2982 6%23:38:32
3news.icm.edu.pl 50 294 137 124 33 46%19:42:32
4localhost 7 6 6 0 0 100%00:00:00
TOTAL: 4 1319 26908732595394 89859 5620 96%432:02:24
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1newsfeed.pionier.net.pl671.0 GB10.1 MB130.9 MB671.2 GB 99%271.6 KB
2news.nask.pl99.3 MB102.7 MB112.5 MB314.6 MB 31%34.7 KB
3news.icm.edu.pl2.5 MB57.9 KB771.2 KB3.3 MB 75%20.1 KB
4localhost10.1 KB0.0 KB0.0 KB10.1 KB100%1.7 KB
TOTAL: 4671.1 GB112.9 MB244.1 MB671.5 GB 99%270.7 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Aug 21 04:15:02 - 04:59:59 83999 3.2% 31.1322.9 GB 3.4%8887.07
Aug 21 05:00:00 - 05:59:59 101221 3.9% 28.1229.5 GB 4.4%8580.67
Aug 21 06:00:00 - 06:59:59 108509 4.2% 30.1428.6 GB 4.3%8338.27
Aug 21 07:00:00 - 07:59:59 82886 3.2% 23.0225.2 GB 3.7%7327.86
Aug 21 08:00:00 - 08:59:59 62900 2.4% 17.4719.8 GB 2.9%5759.62
Aug 21 09:00:00 - 09:59:59 138667 5.3% 38.5231.0 GB 4.6%9022.19
Aug 21 10:00:00 - 10:59:59 99994 3.9% 27.7828.0 GB 4.2%8160.31
Aug 21 11:00:00 - 11:59:59 62922 2.4% 17.4815.7 GB 2.3%4587.46
Aug 21 12:00:00 - 12:59:59 121677 4.7% 33.8033.6 GB 5.0%9795.42
Aug 21 13:00:00 - 13:59:59 107177 4.1% 29.7731.4 GB 4.7%9154.27
Aug 21 14:00:00 - 14:59:59 86540 3.3% 24.0422.7 GB 3.4%6605.99
Aug 21 15:00:00 - 15:59:59 171993 6.6% 47.7838.2 GB 5.7%11128.00
Aug 21 16:00:00 - 16:59:59 143657 5.5% 39.9038.7 GB 5.8%11260.91
Aug 21 17:00:00 - 17:59:59 74463 2.9% 20.6821.1 GB 3.1%6144.20
Aug 21 18:00:00 - 18:59:59 130019 5.0% 36.1225.2 GB 3.8%7344.26
Aug 21 19:00:00 - 19:59:59 137887 5.3% 38.3029.3 GB 4.4%8545.55
Aug 21 20:00:00 - 20:59:59 168545 6.5% 46.8233.9 GB 5.1%9887.93
Aug 21 21:00:00 - 21:59:59 83064 3.2% 23.0720.2 GB 3.0%5890.49
Aug 21 22:00:00 - 22:59:59 112245 4.3% 31.1826.4 GB 3.9%7686.97
Aug 21 23:00:00 - 23:59:59 129661 5.0% 36.0234.4 GB 5.1%10029.50
Aug 22 00:00:00 - 00:59:59 79640 3.1% 22.1220.6 GB 3.1%5996.01
Aug 22 01:00:00 - 01:59:59 89971 3.5% 24.9928.3 GB 4.2%8236.51
Aug 22 02:00:00 - 02:59:59 102173 3.9% 28.3830.7 GB 4.6%8948.95
Aug 22 03:00:00 - 03:59:59 90684 3.5% 25.1927.1 GB 4.0%7882.89
Aug 22 04:00:00 - 04:15:02 25011 1.0% 27.738.7 GB 1.3%10152.61
TOTAL: 24:00:00 2595505 100.0% 30.04671.3 GB 100.0%8146.60
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1news.nask.pl 3136 3 0 1796 7 0 0 0 1330
2newsfeed.pionier.net.pl 2950 132 0 1708 6 0 0 0 1104
3news.icm.edu.pl 19 0 0 1 0 0 0 0 18
TOTAL: 3 6105 135 0 3505 13 0 0 0 2452

Unwanted newsgroups [Top 20]:

NewsgroupCount
uk.railway 104
it.comp.os.win.windows10 14
it.tlc.cellulari.android 4
comp.mobile.android 4
hr.ponuda.hardver.komponente 3
de.comp.lang.vbclassic 2
comp.mobile.ipad 2
it.comp.os.linux.ubuntu 1
it.comp.os.win.windows8 1
TOTAL: 9 135

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

GroupsCount
pl.sci.matematyka 7
pl.praca.oferowana 5
bit.listserv.catholic 1
TOTAL: 3 13

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 1040
Binary in non-binary group 790
EMP (phl) 36
Scoring filter (8) 15
HTML post 13
Scoring filter (9) 9
Scoring filter (16) 8
Scoring filter (18) 3
Too many newsgroups 2
Attached HTML file 1
Scoring filter (14) 1
Scoring filter (11) 1
TOTAL: 12 1919

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Article posted in the future
newsfeed.pionier.net.pl 9
TOTAL: 1 9
Including strange strings
newsfeed.pionier.net.pl 353
news.nask.pl 167
news.icm.edu.pl 3
TOTAL: 3 523
TOTAL: 2 532

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1nask 285416 133553 89685 25 0 6670 46%23:59:57
2panorama 260512 1812 228755 1063 11 230633 0%23:59:57
3poznan 8616 164 6214 20 0 0 1%23:59:57
4icm 307344 13 219726 15608 0 14 0%23:59:57
5okapi 0 0 0 0 0 1255 0%23:57:50
TOTAL: 5 861888 135542 544380 16716 11 238572 15%119:57:38
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1nask71.7 GB10.1 MB71.7 GB869.8 KB/s562.6 KB23:59:57
2panorama222.7 MB53.2 MB275.9 MB3.3 KB/s98.3 KB23:59:57
3poznan613.5 KB69.1 KB682.6 KB0.0 KB/s3.7 KB23:59:57
4icm435.5 KB7.3 GB7.3 GB88.9 KB/s491.7 KB23:59:57
5okapi0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:50
TOTAL: 571.9 GB7.4 GB79.3 GB192.4 KB/s545.9 KB119:57:38
Outgoing feeds (innfeed) by Volume

Backlog files shrunk by innfeed:

ServerSize
panorama2.9 MB
TOTAL: 12.9 MB

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1web.man.lodz.pl 288 4438.7 KB 21 0 000:00:19
2isvcs01.man.lodz.pl 6 00.0 KB 0 6 000:00:00
TOTAL: 2 294 4438.7 KB 21 6 000:00:34

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.man.lodz.pl 678 4438.7 KB 21 6 000:00:24
2unresolved 2 00.0 KB 0 0 000:00:09
TOTAL: 2 680 4438.7 KB 21 6 000:00:34

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
web.man.lodz.pl 1.208 4.236 0.00000:00:19
107.170.205.176 0.000 0.012 0.00000:00:09
mon.man.lodz.pl 0.992 3.532 0.00000:00:03
david.man.lodz.pl 0.332 1.248 0.00000:00:01
isvcs01.man.lodz.pl 0.032 0.088 0.00000:00:00
78.128.112.22 0.004 0.008 0.00000:00:00
TOTAL: 6 2.568 9.124 0.00000:00:34

Curious NNRP server explorers [Top 20]:

SystemConn
mon.man.lodz.pl 288
david.man.lodz.pl 96
107.170.205.176 1
78.128.112.22 1
TOTAL: 4 386

NNRP unrecognized commands (by host):

SystemConn
78.128.112.22 1
TOTAL: 1 1

NNRP unrecognized commands (by command):

CommandCount
#003 1
TOTAL: 1 1

NNRP client timeouts [Top 20]:

SystemConnPeer
78.128.112.22 1 1
TOTAL: 1 1 1

Newsgroup request counts (by category):

CategoryCountPct
1pl 44100.0%
TOTAL: 1 44100.0%

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

NewsgroupCount
1pl.comp.pecet 26
2pl.comp.os.ms-windows.winnt 18
TOTAL: 2 44