Daily Usenet report

Jun 18 04:15:02 -- Jun 19 04:15:02

Unknown entries from news log file:

First 12 / 12 lines (100.0%)

Jun 18 08:03:36 newsfeed overchan[8425]: input line too long, skipping
Jun 18 08:03:57 newsfeed overchan[8425]: input line too long, skipping
Jun 18 08:04:17 newsfeed overchan[8425]: input line too long, skipping
Jun 18 13:31:06 newsfeed overchan[8425]: input line too long, skipping
Jun 18 13:31:28 newsfeed overchan[8425]: input line too long, skipping
Jun 18 13:31:47 newsfeed overchan[8425]: input line too long, skipping
Jun 18 18:21:29 newsfeed overchan[8425]: input line too long, skipping
Jun 18 19:26:31 newsfeed overchan[8425]: input line too long, skipping
Jun 18 19:26:51 newsfeed overchan[8425]: input line too long, skipping
Jun 18 19:27:13 newsfeed overchan[8425]: input line too long, skipping
Jun 18 19:31:53 newsfeed overchan[8425]: input line too long, skipping
Jun 18 20:18:07 newsfeed overchan[8425]: input line too long, skipping

Log entries by program:

Program nameLines%LinesSize%Size
inn2715087 98.3%307.8 MB 97.9%
innd 21965 0.8%3.5 MB 1.1%
innfeed 20813 0.8%2.5 MB 0.8%
nnrpd 4857 0.2%515.7 KB 0.2%
overchan 13 0.0%2.3 KB 0.0%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 62762736 100.0%314.3 MB100.0%

History cache:

ReasonCount%Count
Do not exist 2618218 70.3%
Negative hits 932804 25.1%
Positive hits 171154 4.6%
Cache misses 391 0.0%
TOTAL: 4 3722567 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:02.698 0.0%217 0.000 12.433 207.857
article cleanup00:00:36.673 0.0%2715617 0.009 0.014 0.019
article logging00:02:16.674 0.2%2716214 0.030 0.050 0.273
article parse00:45:17.495 3.1%76055914 0.017 0.036 0.048
article write00:18:19.324 1.3%2619790 0.202 0.420 1.415
artlog/artcncl00:00:00.006 0.0%212 0.000 0.028 1.000
artlog/artparse00:00:00.000 0.0%2 0.000 0.000 0.000
data move00:02:02.557 0.1%90525173 0.001 0.001 0.002
hisgrep/artcncl00:00:00.682 0.0%215 0.000 3.172 67.143
hishave/artcncl00:00:00.990 0.0%217 0.000 4.562 120.857
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:51:21.335 3.6%3733229 0.042 0.825 9.299
history sync00:00:00.022 0.0%291 0.000 0.076 1.000
history write01:31:03.091 6.3%2623633 0.299 2.082 10.369
hiswrite/artcncl00:00:00.000 0.0%2 0.000 0.000 0.000
idle14:17:51.677 59.6%57770728 0.391 0.891 5.250
nntp read00:53:22.179 3.7%74451021 0.026 0.043 0.058
overview write00:00:14.722 0.0%2619790 0.003 0.006 0.009
perl filter04:43:27.029 19.7%2623621 3.580 6.482 10.648
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:06:12.772 0.4%5545258 0.044 0.067 0.112
TOTAL: 24:00:04.78223:32:09.926 98.1%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:01.319 0.0%434008 0.000 0.003 0.007
article prepare00:00:00.020 0.0%90206 0.000 0.000 0.011
article read00:00:40.115 0.0%17738 0.000 2.262 114.000
backlog stats00:00:01.069 0.0%1490200 0.000 0.001 0.002
callbacks00:00:00.000 0.0%1 0.000 0.000 0.000
data read00:00:17.348 0.0%959024 0.010 0.018 0.028
data write00:01:17.472 0.1%683832 0.042 0.113 0.383
idle23:48:08.800 99.8%1490200 19.282 57.502 207.608
status file00:00:08.323 0.0%8270 0.000 1.006 9.000
TOTAL: 23:51:11.78123:50:34.466100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:03:17.093 93.3%3889 0.000 50.680 10044.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.363 0.2%8385 0.000 0.043 0.667
readart00:00:00.000 0.0%10 0.000 0.000 0.000
TOTAL: 00:03:31.31600:03:17.456 93.4%----

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

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1newsfeed.pionier.net.pl 1035 26199402510805 23906 85229 95%391:18:48
2news.nask.pl 2 175092 108674 55886 10532 62%23:58:44
3news.icm.edu.pl 44 212 59 139 14 27%16:27:35
4localhost 1 0 0 0 0 0%00:00:00
TOTAL: 4 1082 27952442619538 79931 95775 93%431:45:07
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1newsfeed.pionier.net.pl569.5 GB29.2 GB29.3 GB627.9 GB 90%253.6 KB
2news.nask.pl36.0 GB2.4 GB2.4 GB40.7 GB 88%358.2 KB
3news.icm.edu.pl1.1 MB0.0 KB619.8 KB1.7 MB 64%24.2 KB
4localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 4605.4 GB31.5 GB31.7 GB668.7 GB 90%258.2 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Jun 18 04:15:02 - 04:59:59 64795 2.5% 24.0219.6 GB 3.2%7598.91
Jun 18 05:00:00 - 05:59:59 119657 4.6% 33.2427.9 GB 4.6%8130.04
Jun 18 06:00:00 - 06:59:59 22015 0.8% 6.127.6 GB 1.3%2219.12
Jun 18 07:00:00 - 07:59:59 19012 0.7% 5.287.8 GB 1.3%2273.30
Jun 18 08:00:00 - 08:59:59 21287 0.8% 5.918.0 GB 1.3%2337.83
Jun 18 09:00:00 - 09:59:59 56827 2.2% 15.7918.0 GB 3.0%5242.83
Jun 18 10:00:00 - 10:59:59 126484 4.8% 35.1333.2 GB 5.5%9658.03
Jun 18 11:00:00 - 11:59:59 212388 8.1% 59.0038.0 GB 6.3%11055.02
Jun 18 12:00:00 - 12:59:59 129490 4.9% 35.9729.5 GB 4.9%8579.61
Jun 18 13:00:00 - 13:59:59 103594 4.0% 28.7830.2 GB 5.0%8797.75
Jun 18 14:00:00 - 14:59:59 130417 5.0% 36.2329.1 GB 4.8%8483.51
Jun 18 15:00:00 - 15:59:59 215305 8.2% 59.8130.0 GB 5.0%8742.44
Jun 18 16:00:00 - 16:59:59 188368 7.2% 52.3233.1 GB 5.5%9639.37
Jun 18 17:00:00 - 17:59:59 117054 4.5% 32.5228.9 GB 4.8%8414.72
Jun 18 18:00:00 - 18:59:59 125274 4.8% 34.8030.0 GB 5.0%8750.68
Jun 18 19:00:00 - 19:59:59 197236 7.5% 54.7936.8 GB 6.1%10732.31
Jun 18 20:00:00 - 20:59:59 93449 3.6% 25.9614.1 GB 2.3%4111.14
Jun 18 21:00:00 - 21:59:59 62043 2.4% 17.2317.3 GB 2.9%5034.45
Jun 18 22:00:00 - 22:59:59 84869 3.2% 23.5723.5 GB 3.9%6840.14
Jun 18 23:00:00 - 23:59:59 131737 5.0% 36.5933.9 GB 5.6%9866.05
Jun 19 00:00:00 - 00:59:59 84461 3.2% 23.4622.8 GB 3.8%6634.08
Jun 19 01:00:00 - 01:59:59 105579 4.0% 29.3330.1 GB 5.0%8766.26
Jun 19 02:00:00 - 02:59:59 116895 4.5% 32.4730.1 GB 5.0%8779.11
Jun 19 03:00:00 - 03:59:59 72083 2.8% 20.0219.8 GB 3.3%5766.20
Jun 19 04:00:00 - 04:15:02 18207 0.7% 20.196.0 GB 1.0%6929.42
TOTAL: 24:00:00 2618526 100.0% 30.31605.2 GB 100.0%7345.22
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1newsfeed.pionier.net.pl 85574 212 0 84693 3 0 0 0 666
2news.nask.pl 10746 24 0 7214 2 0 0 0 3506
3news.icm.edu.pl 28 0 0 0 0 0 0 0 28
TOTAL: 3 96348 236 0 91907 5 0 0 0 4200

Unwanted newsgroups [Top 20]:

NewsgroupCount
uk.railway 136
it.tlc.cellulari.android 47
it.comp.os.win.windows10 16
de.comm.software.mailreader 15
comp.sys.raspberry-pi 8
it.comp.os.win.windows8 3
de.rec.sf.startrek 3
de.comp.lang.perl 3
hr.ponuda.hardver.komponente 2
comp.mobile.android 2
uk.net.providers.gradwell 1
TOTAL: 11 236

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

GroupsCount
pl.sci.matematyka 2
christnet.prayer 1
pl.praca.oferowana 1
bit.listserv.catholic 1
TOTAL: 4 5

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 3083
Binary in non-binary group 418
EMP (phl) 27
Scoring filter (8) 23
Scoring filter (9) 20
Too many newsgroups 5
Scoring filter (18) 4
Scoring filter (11) 4
Scoring filter (16) 3
HTML post 2
Scoring filter (14) 1
Scoring filter (13) 1
TOTAL: 12 3591

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Article posted in the future
newsfeed.pionier.net.pl 10
TOTAL: 1 10
Including strange strings
newsfeed.pionier.net.pl 371
news.nask.pl 215
news.icm.edu.pl 11
TOTAL: 3 597
TOTAL: 2 607

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1nask 227470 12687 175346 28 1 1 5%23:59:58
2panorama 138034 1719 122693 81 4 309922 1%23:59:58
3poznan 10160 171 6562 20 0 0 1%23:59:56
4icm 357841 80 296020 7689 0 1193 0%23:59:58
5okapi 0 0 0 0 0 933 0%23:57:51
TOTAL: 5 733505 14657 600621 7818 5 312049 1%119:57:41
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1nask4.5 GB8.1 MB4.5 GB55.2 KB/s374.9 KB23:59:58
2panorama515.4 MB2.5 MB517.9 MB6.1 KB/s294.6 KB23:59:58
3poznan1.2 MB98.9 KB1.3 MB0.0 KB/s6.8 KB23:59:56
4icm195.5 KB2.7 GB2.7 GB33.1 KB/s368.0 KB23:59:58
5okapi0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:51
TOTAL: 55.0 GB2.7 GB7.8 GB18.9 KB/s363.0 KB119:57:41
Outgoing feeds (innfeed) by Volume

Backlog files shrunk by innfeed:

ServerSize
panorama12.9 MB
TOTAL: 112.9 MB

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1web.man.lodz.pl 288 109.1 KB 5 0 000:00:23
TOTAL: 1 288 109.1 KB 5 0 000:03:30

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.man.lodz.pl 672 109.1 KB 5 0 000:00:28
2unresolved 2 00.0 KB 0 0 000:01:25
3*.static.corbina.ru 11 00.0 KB 0 0 000:01:36
TOTAL: 3 685 109.1 KB 5 0 000:03:30

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
0890788407.static.corbina.ru 0.036 0.212 0.00000:01:36
185.48.195.78 0.028 0.184 0.00000:01:25
web.man.lodz.pl 1.808 6.584 0.00000:00:23
mon.man.lodz.pl 1.508 6.036 0.00000:00:03
david.man.lodz.pl 0.516 1.896 0.00000:00:01
TOTAL: 5 3.896 14.912 0.00000:03:30

Curious NNRP server explorers [Top 20]:

SystemConn
mon.man.lodz.pl 288
david.man.lodz.pl 96
0890788407.static.corbina.ru 11
185.48.195.78 2
TOTAL: 4 397

Newsgroup request counts (by category):

CategoryCountPct
1pl 10100.0%
TOTAL: 1 10100.0%

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

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