Daily Usenet report

May 11 04:15:03 -- May 12 04:15:02

Unknown entries from news log file:

First 6 / 6 lines (100.0%)

May 11 10:28:00 newsfeed nnrpd[11437]: SERVER perl filter not defined
May 11 13:03:43 newsfeed nnrpd[16790]: SERVER perl filter not defined
May 11 13:12:21 newsfeed nnrpd[16681]: message repeated 4 times: [ wireless.ics.p.lodz.pl group alt.test.pl 0]
May 11 13:42:45 newsfeed nnrpd[18216]: SERVER perl filter not defined
May 11 16:47:40 newsfeed nnrpd[24640]: SERVER perl filter not defined
May 11 17:33:00 newsfeed nnrpd[26274]: SERVER perl filter not defined

Log entries by program:

Program nameLines%LinesSize%Size
inn2655687 97.2%300.9 MB 96.8%
innfeed 45633 1.7%5.4 MB 1.7%
innd 24164 0.9%4.0 MB 1.3%
nnrpd 5851 0.2%626.8 KB 0.2%
TOTAL: 42731335 100.0%310.9 MB100.0%

History cache:

ReasonCount%Count
Do not exist 2647426 98.2%
Negative hits 31416 1.2%
Positive hits 15733 0.6%
Cache misses 97 0.0%
TOTAL: 4 2694672 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:01.649 0.0%206 0.000 8.005 305.000
article cleanup00:00:38.596 0.0%2652884 0.006 0.015 0.030
article logging00:01:18.738 0.1%2653616 0.014 0.030 0.439
article parse01:19:19.114 5.5%201926420 0.010 0.024 0.085
article write00:25:48.728 1.8%2644911 0.312 0.586 2.922
artlog/artcncl00:00:00.001 0.0%203 0.000 0.005 1.000
artlog/artparse00:00:00.000 0.0%3 0.000 0.000 0.000
data move00:02:54.135 0.2%219044950 0.000 0.001 0.007
hisgrep/artcncl00:00:00.100 0.0%188 0.000 0.532 12.000
hishave/artcncl00:00:00.038 0.0%206 0.000 0.184 7.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:33:48.331 2.3%2695865 0.105 0.752 13.828
history sync00:00:00.017 0.0%292 0.000 0.058 1.000
history write00:46:06.754 3.2%2648680 0.183 1.045 22.219
hiswrite/artcncl00:00:00.045 0.0%18 0.000 2.500 22.000
idle13:10:57.157 55.0%145231402 0.113 0.327 0.603
nntp read01:14:42.768 5.2%199840327 0.010 0.022 0.040
overview write00:00:15.265 0.0%2644911 0.000 0.006 0.014
perl filter05:35:48.926 23.3%2648677 4.327 7.607 11.224
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:04:34.667 0.3%5321191 0.008 0.052 0.091
TOTAL: 23:59:14.65623:16:15.029 97.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.214 0.0%75928 0.000 0.003 0.091
article prepare00:00:00.010 0.0%40280 0.000 0.000 0.125
article read00:01:05.523 0.1%10008 0.000 6.547 645.000
backlog stats00:00:00.228 0.0%267484 0.000 0.001 0.020
callbacks00:00:00.000 0.0%2 0.000 0.000 0.000
data read00:00:01.759 0.0%137058 0.000 0.013 0.104
data write00:00:09.251 0.0%119214 0.000 0.078 0.771
idle23:58:09.107 99.9%267484 93.162 322.595 1094.218
status file00:00:17.616 0.0%15530 0.167 1.134 184.833
TOTAL: 23:59:55.93423:59:43.708100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle02:23:12.027 99.7%31196 0.000 275.421102716.375
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:08.648 0.1%244760 0.000 0.035 0.526
readart00:00:00.166 0.0%59 0.000 2.814 147.000
TOTAL: 02:23:41.23802:23:20.841 99.8%----

Control commands to INND:

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

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1newsfeed.pionier.net.pl 1011 26463262641345 776 4205 99%306:45:51
2news.nask.pl 2 19230 5100 10403 3727 26%23:49:59
3news.icm.edu.pl 42 327 41 240 46 12%15:27:01
4localhost 6 5 5 0 0 100%00:00:00
TOTAL: 4 1061 26658882646491 11419 7978 99%346:02:51
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1newsfeed.pionier.net.pl853.3 GB25.5 MB27.3 MB853.3 GB 99%338.2 KB
2news.nask.pl27.0 MB999.0 KB77.1 MB105.0 MB 25%12.2 KB
3news.icm.edu.pl1.6 MB0.0 KB961.8 KB2.5 MB 63%30.0 KB
4localhost6.8 KB0.0 KB0.0 KB6.8 KB100%1.4 KB
TOTAL: 4853.3 GB26.5 MB105.3 MB853.4 GB 99%337.1 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
May 11 04:15:03 - 04:59:59 84474 3.2% 31.3225.8 GB 3.0%10043.32
May 11 05:00:00 - 05:59:59 133918 5.1% 37.2039.1 GB 4.6%11390.50
May 11 06:00:00 - 06:59:59 135237 5.1% 37.5740.8 GB 4.8%11891.34
May 11 07:00:00 - 07:59:59 128730 4.9% 35.7641.5 GB 4.9%12077.98
May 11 08:00:00 - 08:59:59 82170 3.1% 22.8229.5 GB 3.5%8587.04
May 11 09:00:00 - 09:59:59 104213 3.9% 28.9538.4 GB 4.5%11194.56
May 11 10:00:00 - 10:59:59 83955 3.2% 23.3230.4 GB 3.6%8868.40
May 11 11:00:00 - 11:59:59 79873 3.0% 22.1927.4 GB 3.2%7977.36
May 11 12:00:00 - 12:59:59 88747 3.4% 24.6530.4 GB 3.6%8845.98
May 11 13:00:00 - 13:59:59 112754 4.3% 31.3239.0 GB 4.6%11368.49
May 11 14:00:00 - 14:59:59 80667 3.0% 22.4127.0 GB 3.2%7860.22
May 11 15:00:00 - 15:59:59 82196 3.1% 22.8329.1 GB 3.4%8461.68
May 11 16:00:00 - 16:59:59 89033 3.4% 24.7329.9 GB 3.5%8714.48
May 11 17:00:00 - 17:59:59 111519 4.2% 30.9835.6 GB 4.2%10360.06
May 11 18:00:00 - 18:59:59 110705 4.2% 30.7540.4 GB 4.7%11764.00
May 11 19:00:00 - 19:59:59 118870 4.5% 33.0241.8 GB 4.9%12171.09
May 11 20:00:00 - 20:59:59 111259 4.2% 30.9137.8 GB 4.4%11001.29
May 11 21:00:00 - 21:59:59 117466 4.4% 32.6339.9 GB 4.7%11617.76
May 11 22:00:00 - 22:59:59 132093 5.0% 36.6941.4 GB 4.9%12069.96
May 11 23:00:00 - 23:59:59 144762 5.5% 40.2140.1 GB 4.7%11694.52
May 12 00:00:00 - 00:59:59 108791 4.1% 30.2232.4 GB 3.8%9436.52
May 12 01:00:00 - 01:59:59 126244 4.8% 35.0735.3 GB 4.1%10272.74
May 12 02:00:00 - 02:59:59 113416 4.3% 31.5032.7 GB 3.8%9530.34
May 12 03:00:00 - 03:59:59 131519 5.0% 36.5337.0 GB 4.3%10779.26
May 12 04:00:00 - 04:15:02 34163 1.3% 37.879.7 GB 1.1%11250.62
TOTAL: 23:59:59 2646774 100.0% 30.63852.4 GB 100.0%10345.06
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1newsfeed.pionier.net.pl 4846 237 0 3859 0 0 0 0 750
2news.nask.pl 3817 2 0 350 6 0 0 0 3459
3news.icm.edu.pl 47 0 0 0 0 0 0 0 47
TOTAL: 3 8710 239 0 4209 6 0 0 0 4256

Unwanted newsgroups [Top 20]:

NewsgroupCount
uk.railway 144
it.comp.os.win.windows10 37
it.tlc.cellulari.android 34
comp.mobile.android 6
de.comp.lang.vbclassic 6
comp.sys.raspberry-pi 4
it.comp.os.win.windows7 2
nl.comp.sys.android 2
hr.ponuda.hardver.konfiguracije 1
comp.mobile.ipad 1
it.comp.os.win.windows8 1
it.discussioni.energia 1
TOTAL: 12 239

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

GroupsCount
pl.sci.matematyka 2
pl.sci.historia 2
pl.praca.oferowana 1
bit.listserv.catholic 1
TOTAL: 4 6

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 1645
Binary in non-binary group 1103
PFM bot misc 320
EMP (phl) 146
Scoring filter (9) 67
Scoring filter (8) 62
Scoring filter (14) 29
Scoring filter (13) 28
Scoring filter (12) 28
Scoring filter (10) 27
Scoring filter (11) 19
Scoring filter (16) 11
HTML post 10
Poison newsgroup 10
Scoring filter (15) 7
Scoring filter (17) 3
EMP (fsl) 2
Scoring filter (18) 1
Attached HTML file 1
Scoring filter (19) 1
TOTAL: 20 3520

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1panorama 51359 1343 23666 559 6 50334 2%24:00:00
2icm 43304 1016 23163 6114 0 0 2%23:56:37
3poznan 7802 132 4896 31 0 0 1%23:57:29
4nask 20210 99 11137 1 0 0 0%24:02:19
5okapi 0 0 0 0 0 2615 0%24:00:02
TOTAL: 5 122675 2590 62862 6705 6 52949 2%119:56:27
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1icm9.4 MB1.8 GB1.8 GB22.0 KB/s265.4 KB23:56:37
2panorama3.9 MB3.7 MB7.6 MB0.1 KB/s4.1 KB24:00:00
3poznan1.0 MB101.7 KB1.1 MB0.0 KB/s7.0 KB23:57:29
4nask311.8 KB0.7 KB312.5 KB0.0 KB/s3.1 KB24:02:19
5okapi0.0 KB0.0 KB0.0 KB0.0 KB/s024:00:02
TOTAL: 514.6 MB1.8 GB1.8 GB4.4 KB/s204.6 KB119:56:27
Outgoing feeds (innfeed) by Volume

Backlog files shrunk by innfeed:

ServerSize
okapi488.4 KB
TOTAL: 1488.4 KB

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1web.man.lodz.pl 288 5047.3 KB 20 0 000:00:29
2radius2.p.lodz.pl 4 32.3 KB 3 1 000:04:07
3wireless.ics.p.lodz.pl 2 00.0 KB 0 1 000:17:09
4isvcs01.man.lodz.pl 3 00.0 KB 0 3 000:00:00
TOTAL: 4 297 5349.6 KB 23 5 002:23:40

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.man.lodz.pl 675 5047.3 KB 20 3 000:00:34
2*.p.lodz.pl 4 32.3 KB 3 1 000:04:07
3unresolved 5 00.0 KB 0 0 002:00:04
4*.versanet.de 178 00.0 KB 0 0 000:00:48
5*.play-internet.pl 1 00.0 KB 0 0 000:00:22
6*.toya.net.pl 68 00.0 KB 0 0 000:00:04
7*.elsnet.pl 4 00.0 KB 0 0 000:00:28
8*.ics.p.lodz.pl 2 00.0 KB 0 1 000:17:09
TOTAL: 8 937 5349.6 KB 23 5 002:23:40

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
185.48.194.153 1.513 2.124 0.00001:59:44
wireless.ics.p.lodz.pl 0.283 0.143 0.00000:17:09
radius2.p.lodz.pl 0.404 0.293 0.00000:04:07
i59f5c34f.versanet.de 0.634 2.563 0.00000:00:48
web.man.lodz.pl 0.892 4.340 0.00000:00:29
host227.elsnet.pl 0.017 0.061 0.00000:00:28
user-94-254-226-28.play-internet.pl 0.000 0.020 0.00000:00:22
212.51.203.199 0.005 0.022 0.00000:00:18
staticline41435.toya.net.pl 0.235 0.892 0.00000:00:04
mon.man.lodz.pl 0.961 3.870 0.00000:00:03
196.52.20.12 0.000 0.021 0.00000:00:01
david.man.lodz.pl 0.243 1.319 0.00000:00:01
isvcs01.man.lodz.pl 0.013 0.057 0.00000:00:00
TOTAL: 13 5.200 15.725 0.00002:23:40

Curious NNRP server explorers [Top 20]:

SystemConn
mon.man.lodz.pl 288
i59f5c34f.versanet.de 178
david.man.lodz.pl 96
staticline41435.toya.net.pl 68
host227.elsnet.pl 4
185.48.194.153 2
212.51.203.199 2
user-94-254-226-28.play-internet.pl 1
196.52.20.12 1
TOTAL: 9 640

NNRP client timeouts [Top 20]:

SystemConnPeer
185.48.194.153 1 1
TOTAL: 1 1 1

Newsgroup request counts (by category):

CategoryCountPct
1pl 50 94.3%
2alt 3 5.7%
TOTAL: 2 53100.0%

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

NewsgroupCount
1pl.comp.pecet 38
2pl.comp.os.ms-windows.winnt 10
3alt.test.pl 3
4pl.internet.polip 2
TOTAL: 4 53