Daily Usenet report

Nov 23 04:15:02 -- Nov 24 04:15:02

Unknown entries from news log file:

First 11 / 11 lines (100.0%)

Nov 23 04:15:02 newsfeed nnrpd[6372]: web.man.lodz.pl rejected Flushing log and syslog files
Nov 23 04:15:02 newsfeed nnrpd[6378]: web.man.lodz.pl rejected Flushing log and syslog files
Nov 23 04:15:02 newsfeed nnrpd[6380]: web.man.lodz.pl rejected Flushing log and syslog files
Nov 23 08:55:40 newsfeed nnrpd[16625]: SERVER perl filter not defined
Nov 23 10:09:37 newsfeed nnrpd[19274]: SERVER perl filter not defined
Nov 23 12:36:45 newsfeed nnrpd[24424]: SERVER perl filter not defined
Nov 23 15:10:33 newsfeed nnrpd[29842]: SERVER perl filter not defined
Nov 23 15:29:51 newsfeed nnrpd[30446]: message repeated 3 times: [ 193.106.100.10 group lodz.test 0]
Nov 23 21:22:11 newsfeed nnrpd[9942]: message repeated 3 times: [ staticline-31-182-80-178.toya.net.pl group lodz.test 0]
Nov 24 02:47:15 newsfeed nnrpd[21355]: message repeated 3 times: [ host-89-228-166-7.lodz.mm.pl group lodz.test 0]
Nov 24 03:18:48 newsfeed nnrpd[22477]: SERVER perl filter not defined

Log entries by program:

Program nameLines%LinesSize%Size
inn2780297 97.4%321.5 MB 97.0%
innfeed 46301 1.6%5.5 MB 1.7%
innd 22796 0.8%3.9 MB 1.2%
nnrpd 5796 0.2%634.5 KB 0.2%
TOTAL: 42855190 100.0%331.6 MB100.0%

History cache:

ReasonCount%Count
Do not exist 2773329 98.0%
Negative hits 38966 1.4%
Positive hits 16449 0.6%
Cache misses 98 0.0%
TOTAL: 4 2828842 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:02.363 0.0%197 0.000 11.995 269.000
article cleanup00:00:47.664 0.1%2779858 0.007 0.017 0.036
article logging00:01:18.238 0.1%2780318 0.015 0.028 0.329
article parse01:25:05.759 5.9%256390415 0.006 0.020 0.071
article write00:45:14.120 3.1%2774034 0.330 0.978 3.243
artlog/artcncl00:00:00.004 0.0%192 0.000 0.021 1.000
artlog/artparse00:00:00.010 0.0%308 0.000 0.032 1.000
data move00:06:23.347 0.4%274088569 0.001 0.001 0.005
hisgrep/artcncl00:00:00.161 0.0%157 0.000 1.025 18.000
hishave/artcncl00:00:00.317 0.0%197 0.000 1.609 179.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:38:23.032 2.7%2831000 0.121 0.814 17.610
history sync00:00:00.010 0.0%291 0.000 0.034 1.000
history write00:53:09.942 3.7%2775527 0.093 1.149 38.338
hiswrite/artcncl00:00:00.119 0.0%40 0.000 2.975 17.000
idle11:43:10.717 48.8%169480097 0.078 0.249 0.732
nntp read01:39:51.142 6.9%254175879 0.009 0.024 0.049
overview write00:00:15.954 0.0%2774034 0.001 0.006 0.014
perl filter05:38:34.946 23.5%2775219 4.144 7.320 11.876
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:05:36.336 0.4%5693109 0.025 0.059 0.128
TOTAL: 24:00:17.50522:57:54.181 95.7%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.651 0.0%233776 0.000 0.003 0.048
article prepare00:00:00.017 0.0%39666 0.000 0.000 0.083
article read00:01:10.965 0.1%9898 0.000 7.170 464.500
backlog stats00:00:00.295 0.0%394904 0.000 0.001 0.019
callbacks00:00:00.000 0.0%10 0.000 0.000 0.000
data read00:00:03.070 0.0%258761 0.000 0.012 0.098
data write00:00:07.784 0.0%117356 0.000 0.066 1.024
idle23:58:49.736 99.9%394904 55.880 218.609 1256.229
status file00:00:12.409 0.0%16055 0.167 0.773 2.167
TOTAL: 24:00:40.41424:00:24.927100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle14:16:55.814 99.9%8643 0.000 5948.839600086.333
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:11.230 0.0%261791 0.000 0.043 7.400
readart00:00:11.635 0.0%796 0.000 14.617 168.000
TOTAL: 14:17:40.88514:17:18.679100.0%----

Control commands to INND:

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

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1newsfeed.pionier.net.pl 1167 27747582768253 863 5642 99%354:06:23
2news.nask.pl 2 16034 5200 10445 389 32%22:58:40
3news.icm.edu.pl 50 278 39 171 68 14%16:33:29
4localhost 7 6 6 0 0 100%00:00:00
TOTAL: 4 1226 27910762773498 11479 6099 99%393:38:32
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1newsfeed.pionier.net.pl820.9 GB25.7 MB239.4 MB821.1 GB 99%310.4 KB
2news.nask.pl18.0 MB988.8 KB1.0 MB20.0 MB 90%3.7 KB
3news.icm.edu.pl1.9 MB31.2 KB1.1 MB3.0 MB 61%28.9 KB
4localhost9.4 KB0.0 KB0.0 KB9.4 KB100%1.6 KB
TOTAL: 4820.9 GB26.7 MB241.6 MB821.2 GB 99%309.8 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Nov 23 04:15:02 - 04:59:59 78005 2.8% 28.9123.6 GB 2.9%9182.92
Nov 23 05:00:00 - 05:59:59 97732 3.5% 27.1529.6 GB 3.6%8622.11
Nov 23 06:00:00 - 06:59:59 103870 3.7% 28.8532.1 GB 3.9%9347.52
Nov 23 07:00:00 - 07:59:59 111086 4.0% 30.8633.1 GB 4.0%9647.59
Nov 23 08:00:00 - 08:59:59 110409 4.0% 30.6733.4 GB 4.1%9726.24
Nov 23 09:00:00 - 09:59:59 118151 4.3% 32.8234.3 GB 4.2%9995.83
Nov 23 10:00:00 - 10:59:59 112041 4.0% 31.1234.0 GB 4.1%9909.81
Nov 23 11:00:00 - 11:59:59 114140 4.1% 31.7134.8 GB 4.2%10138.49
Nov 23 12:00:00 - 12:59:59 112702 4.1% 31.3134.3 GB 4.2%9978.45
Nov 23 13:00:00 - 13:59:59 117091 4.2% 32.5333.2 GB 4.0%9656.14
Nov 23 14:00:00 - 14:59:59 124194 4.5% 34.5035.4 GB 4.3%10311.66
Nov 23 15:00:00 - 15:59:59 111600 4.0% 31.0033.7 GB 4.1%9824.07
Nov 23 16:00:00 - 16:59:59 100026 3.6% 27.7936.5 GB 4.5%10635.42
Nov 23 17:00:00 - 17:59:59 132963 4.8% 36.9337.9 GB 4.6%11048.57
Nov 23 18:00:00 - 18:59:59 123108 4.4% 34.2037.5 GB 4.6%10913.38
Nov 23 19:00:00 - 19:59:59 133809 4.8% 37.1737.0 GB 4.5%10790.50
Nov 23 20:00:00 - 20:59:59 119979 4.3% 33.3338.2 GB 4.7%11116.47
Nov 23 21:00:00 - 21:59:59 132693 4.8% 36.8635.7 GB 4.4%10408.69
Nov 23 22:00:00 - 22:59:59 127547 4.6% 35.4335.9 GB 4.4%10465.64
Nov 23 23:00:00 - 23:59:59 126393 4.6% 35.1136.8 GB 4.5%10711.12
Nov 24 00:00:00 - 00:59:59 99267 3.6% 27.5728.4 GB 3.5%8277.22
Nov 24 01:00:00 - 01:59:59 116026 4.2% 32.2332.8 GB 4.0%9552.60
Nov 24 02:00:00 - 02:59:59 121786 4.4% 33.8334.4 GB 4.2%10024.39
Nov 24 03:00:00 - 03:59:59 102693 3.7% 28.5330.3 GB 3.7%8813.77
Nov 24 04:00:00 - 04:15:02 26202 0.9% 29.057.5 GB 0.9%8765.27
TOTAL: 24:00:00 2773513 100.0% 32.10820.5 GB 100.0%9958.08
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1newsfeed.pionier.net.pl 6024 261 0 4255 2 0 0 0 1506
2news.nask.pl 484 23 0 381 3 0 0 0 77
3news.icm.edu.pl 84 0 0 3 0 0 0 0 81
TOTAL: 3 6592 284 0 4639 5 0 0 0 1664

Unwanted newsgroups [Top 20]:

NewsgroupCount
uk.railway 92
it.comp.os.win.windows10 79
comp.mobile.ipad 32
nl.comp.os.linux.techniek 14
comp.mobile.android 14
it.tlc.cellulari.android 14
comp.sys.mac.vintage 8
nl.comp.sys.android 7
it.comp.os.win.windows7 6
comp.sys.raspberry-pi 5
uk.rec.cycling.moderated 2
hr.rec.glazba.hifi 2
hr.ponuda.hardver.komponente 2
it.discussioni.energia 2
hr.alt.cellular.gsm.iphone 1
rec.arts.tv.x-factor 1
it.comp.os.win.windows8 1
de.comp.office-pakete.ms-office.excel 1
it.tlc.cellulari.iphone 1
TOTAL: 19 284

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

GroupsCount
pl.sci.historia 3
pl.praca.oferowana 1
bit.listserv.catholic 1
TOTAL: 3 5

INND Perl filter [Top 20]:

ReasonCount
EMP (fsl) 445
Binary in non-binary group 371
EMP (md5) 71
Too many newsgroups 7
Scoring filter (10) 1
HTML post 1
TOTAL: 6 896

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1icm 50379 1975 28073 4758 0 21 3%24:03:15
2panorama 99865 1694 70672 882 27 160226 1%23:59:44
3poznan 8300 8 5345 7 0 0 0%24:04:34
4nask 0 0 0 0 0 12710 0%24:00:00
5okapi 0 0 0 0 0 2886 0%24:00:00
TOTAL: 5 158544 3677 104090 5647 27 175843 2%120:07:33
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1icm30.1 MB1.0 GB1.1 GB12.9 KB/s165.7 KB24:03:15
2panorama7.1 MB7.9 MB15.0 MB0.2 KB/s6.0 KB23:59:44
3poznan19.8 KB44.5 KB64.3 KB0.0 KB/s4.3 KB24:04:34
4nask0.0 KB0.0 KB0.0 KB0.0 KB/s024:00:00
5okapi0.0 KB0.0 KB0.0 KB0.0 KB/s024:00:00
TOTAL: 537.3 MB1.0 GB1.1 GB2.6 KB/s121.3 KB120:07:33
Outgoing feeds (innfeed) by Volume

Backlog files shrunk by innfeed:

ServerSize
panorama5.2 MB
okapi488.3 KB
TOTAL: 25.7 MB

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1pc-212-51-218-225.p.lodz.pl 19 4481.0 MB 13 0 004:32:30
2lze200.lze.lodz.pl 11 107282.6 KB 9 0 002:51:24
3web.man.lodz.pl 292 9080.0 KB 39 0 000:00:29
487-206-1-172.dynamic.chello.pl 26 6162.2 KB 6 0 700:13:15
5staticline-31-182-80-178.toya.net.pl 3 3530.4 KB 1 0 000:09:26
6212.51.203.199 4 1380.7 KB 2 0 000:17:20
7host-89-228-166-7.lodz.mm.pl 6 119.4 KB 3 0 000:08:28
8staticline-31-182-66-200.toya.net.pl 4 97.4 KB 2 0 200:09:40
9212.51.207.206 4 76.1 KB 4 2 000:19:39
10193.106.100.10 9 64.8 KB 3 0 100:56:03
11staticline12664.toya.net.pl 17 54.3 KB 4 0 900:30:01
12radius2.p.lodz.pl 2 32.3 KB 2 1 000:31:39
13staticline-31-182-92-99.toya.net.pl 4 10.8 KB 1 0 100:19:42
14isvcs01.man.lodz.pl 3 00.0 KB 0 3 000:00:00
TOTAL: 14 404 7961.6 MB 89 6 2014:17:40

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.p.lodz.pl 21 4511.0 MB 15 1 005:04:10
2*.lze.lodz.pl 11 107282.6 KB 9 0 002:51:24
3*.man.lodz.pl 679 9080.0 KB 39 3 000:00:35
4*.dynamic.chello.pl 26 6162.2 KB 6 0 700:13:15
5*.toya.net.pl 74 5042.9 KB 8 0 1202:44:27
6unresolved 21 2691.6 KB 9 2 102:43:21
7*.lodz.mm.pl 6 119.4 KB 3 0 000:08:28
8*.elsnet.pl 4 00.0 KB 0 0 000:01:57
9*.adsl.inetia.pl 1 00.0 KB 0 0 000:30:00
TOTAL: 9 843 7961.6 MB 89 6 2014:17:40

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
pc-212-51-218-225.p.lodz.pl 0.099 0.318 0.00004:32:30
lze200.lze.lodz.pl 0.063 0.168 0.00002:51:24
staticline-31-182-84-184.toya.net.pl 0.087 0.030 0.00001:01:35
193.106.100.10 0.025 0.103 0.00000:56:03
radius2.p.lodz.pl 0.229 0.250 0.00000:31:39
staticline-31-183-103-20.toya.net.pl 0.023 0.026 0.00000:30:04
212.51.207.254 0.247 0.123 0.00000:30:03
staticline12664.toya.net.pl 0.115 0.219 0.00000:30:01
5.172.237.88 0.024 0.024 0.00000:30:00
87-205-241-203.adsl.inetia.pl 0.034 0.008 0.00000:30:00
staticline-31-182-92-99.toya.net.pl 0.020 0.037 0.00000:19:42
212.51.207.206 0.560 0.265 0.00000:19:39
212.51.203.199 0.011 0.065 0.00000:17:20
87-206-1-172.dynamic.chello.pl 0.166 0.332 0.00000:13:15
89.38.41.173 0.271 0.280 0.00000:10:15
staticline-31-182-66-200.toya.net.pl 0.070 0.051 0.00000:09:40
staticline-31-182-80-178.toya.net.pl 0.129 0.058 0.00000:09:26
host-89-228-166-7.lodz.mm.pl 0.123 0.063 0.00000:08:28
staticline-31-183-134-212.toya.net.pl 0.009 0.026 0.00000:03:49
host227.elsnet.pl 0.030 0.033 0.00000:01:57
TOTAL: 27 4.652 11.397 0.00014:17:40

Curious NNRP server explorers [Top 20]:

SystemConn
mon.man.lodz.pl 288
david.man.lodz.pl 96
staticline41435.toya.net.pl 37
host227.elsnet.pl 4
staticline-31-183-134-212.toya.net.pl 3
staticline-31-182-87-20.toya.net.pl 3
staticline-31-182-84-184.toya.net.pl 2
89.38.41.173 2
87-205-241-203.adsl.inetia.pl 1
5.172.237.88 1
staticline-31-183-103-20.toya.net.pl 1
212.51.207.254 1
TOTAL: 12 439

NNRP gethostbyaddr failures [Top 20]:

SystemConn
? (can't getpeername) 1
TOTAL: 1 1

NNRP client timeouts [Top 20]:

SystemConnPeer
lze200.lze.lodz.pl 4 0
pc-212-51-218-225.p.lodz.pl 3 1
staticline-31-182-84-184.toya.net.pl 2 0
radius2.p.lodz.pl 2 1
212.51.207.254 1 0
staticline-31-183-103-20.toya.net.pl 1 0
5.172.237.88 1 0
87-205-241-203.adsl.inetia.pl 1 0
193.106.100.10 1 0
TOTAL: 9 16 3

Newsgroup request counts (by category):

CategoryCountPct
1pl 664 83.4%
2lodz 104 13.1%
3lodman 23 2.9%
4lodzman 5 0.6%
TOTAL: 4 796100.0%

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

NewsgroupCount
1pl.misc.elektronika 334
2pl.misc.kolej 114
3lodz.test 104
4pl.rec.kuchnia 53
5pl.comp.pecet 51
6pl.comp.os.ms-windows.winnt 50
7pl.comp.os.linux 39
8lodman.test 15
9pl.misc.telefonia.gsm 15
10lodman.info 8
11pl.test 6
12lodzman.test 5
13pl.rec.radio.amatorskie 1
14pl.rec.dom 1
TOTAL: 14 796