Daily Usenet report

Sep 26 04:15:01 -- Sep 27 04:15:01

Unknown entries from news log file:

First 7 / 7 lines (100.0%)

Sep 26 10:41:52 newsfeed nnrpd[392338]: SERVER perl filter not defined
Sep 26 10:48:10 newsfeed nnrpd[392632]: SERVER perl filter not defined
Sep 26 16:06:31 newsfeed overchan[374966]: input line too long, skipping
Sep 26 18:15:03 newsfeed overchan[374966]: input line too long, skipping
Sep 26 18:15:51 newsfeed overchan[374966]: input line too long, skipping
Sep 26 19:44:58 newsfeed overchan[374966]: input line too long, skipping
Sep 26 19:53:15 newsfeed overchan[374966]: input line too long, skipping

Log entries by program:

Program nameLines%LinesSize%Size
inn 132662 90.9%15.1 MB 91.4%
nnrpd 7735 5.3%780.8 KB 4.6%
innd 4214 2.9%532.7 KB 3.2%
innfeed 1334 0.9%134.2 KB 0.8%
overchan 6 0.0%0.6 KB 0.0%
controlchan 1 0.0%0.0 KB 0.0%
TOTAL: 6 145952 100.0%16.5 MB100.0%

History cache:

ReasonCount%Count
Do not exist 132377 95.4%
Negative hits 5539 4.0%
Positive hits 815 0.6%
Cache misses 21 0.0%
TOTAL: 4 138752 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.471 0.0%38 0.000 12.395 28.200
article cleanup00:00:00.945 0.0%132647 0.000 0.007 0.015
article logging00:00:03.183 0.0%132655 0.010 0.024 0.045
article parse00:00:05.024 0.0%617628 0.003 0.008 0.016
article write00:00:18.200 0.0%129973 0.053 0.140 0.947
artlog/artcncl00:00:00.000 0.0%36 0.000 0.000 0.000
data move00:00:00.914 0.0%815829 0.000 0.001 0.003
hisgrep/artcncl00:00:00.230 0.0%38 0.000 6.053 13.000
hishave/artcncl00:00:00.089 0.0%38 0.000 2.342 5.833
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:07:56.584 0.6%138974 1.502 3.429 8.516
history sync00:00:00.020 0.0%301 0.000 0.066 0.500
history write00:11:38.859 0.8%132630 3.004 5.269 9.553
hiswrite/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
idle23:37:02.747 98.4%729465 26.797 116.555 383.776
nntp read00:00:10.966 0.0%613746 0.012 0.018 0.027
overview write00:00:00.402 0.0%129973 0.000 0.003 0.012
perl filter00:02:30.794 0.2%132630 0.803 1.137 1.671
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:00:04.407 0.0%272872 0.008 0.016 0.024
TOTAL: 24:00:22.89123:59:53.835100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.028 0.0%12916 0.000 0.002 0.019
article prepare00:00:00.000 0.0%104 0.000 0.000 0.000
article read00:00:00.001 0.0%26 0.000 0.038 1.000
backlog stats00:00:00.027 0.0%55133 0.000 0.000 0.007
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:00.289 0.0%29567 0.000 0.010 0.042
data write00:00:00.693 0.0%16777 0.006 0.041 0.110
idle23:59:42.226100.0%55133 721.365 1566.797 4285.390
status file00:00:00.180 0.0%349 0.000 0.516 1.000
TOTAL: 23:59:44.52223:59:43.444100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:03:05.317 88.8%4538 0.000 40.837 10050.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.183 0.1%11468 0.000 0.016 0.667
readart00:00:00.448 0.2%314 0.000 1.427 1.490
TOTAL: 00:03:28.65700:03:05.948 89.1%----

Control commands to INND:

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

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1newsfeed.pionier.net.pl 90 130117 129969 0 148 99%44:35:24
2news.icm.edu.pl 2 3146 17 736 2393 0%22:35:56
3localhost 3 2 2 0 0 100%00:00:00
TOTAL: 3 95 133265 129988 736 2541 97%67:11:20
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1newsfeed.pionier.net.pl1.5 GB242.4 KB618.3 KB1.5 GB 99%12.5 KB
2news.icm.edu.pl384.3 KB83.1 KB25.4 MB25.8 MB 1%11.0 KB
3localhost3.1 KB0.0 KB0.0 KB3.1 KB100%1.5 KB
TOTAL: 31.5 GB325.6 KB26.0 MB1.6 GB 98%12.4 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Sep 26 04:15:01 - 04:59:59 3176 2.4% 1.1830.4 MB 1.9% 11.55
Sep 26 05:00:00 - 05:59:59 4578 3.5% 1.2732.6 MB 2.1% 9.27
Sep 26 06:00:00 - 06:59:59 5026 3.9% 1.4051.6 MB 3.3% 14.66
Sep 26 07:00:00 - 07:59:59 4924 3.8% 1.3754.0 MB 3.4% 15.35
Sep 26 08:00:00 - 08:59:59 5644 4.3% 1.5755.1 MB 3.5% 15.68
Sep 26 09:00:00 - 09:59:59 5534 4.3% 1.5450.8 MB 3.2% 14.46
Sep 26 10:00:00 - 10:59:59 4827 3.7% 1.3435.3 MB 2.2% 10.04
Sep 26 11:00:00 - 11:59:59 5185 4.0% 1.4441.5 MB 2.6% 11.80
Sep 26 12:00:00 - 12:59:59 3897 3.0% 1.0829.3 MB 1.9% 8.33
Sep 26 13:00:00 - 13:59:59 5307 4.1% 1.47112.9 MB 7.1% 32.12
Sep 26 14:00:00 - 14:59:59 5853 4.5% 1.6351.5 MB 3.3% 14.64
Sep 26 15:00:00 - 15:59:59 5467 4.2% 1.5255.2 MB 3.5% 15.71
Sep 26 16:00:00 - 16:59:59 4399 3.4% 1.2242.2 MB 2.7% 12.01
Sep 26 17:00:00 - 17:59:59 5807 4.5% 1.6158.2 MB 3.7% 16.55
Sep 26 18:00:00 - 18:59:59 7536 5.8% 2.09119.1 MB 7.5% 33.86
Sep 26 19:00:00 - 19:59:59 5976 4.6% 1.6677.2 MB 4.9% 21.97
Sep 26 20:00:00 - 20:59:59 6187 4.8% 1.7280.3 MB 5.1% 22.86
Sep 26 21:00:00 - 21:59:59 5995 4.6% 1.6784.2 MB 5.3% 23.95
Sep 26 22:00:00 - 22:59:59 6205 4.8% 1.7283.3 MB 5.3% 23.70
Sep 26 23:00:00 - 23:59:59 6060 4.7% 1.6888.5 MB 5.6% 25.17
Sep 27 00:00:00 - 00:59:59 8395 6.5% 2.33128.1 MB 8.1% 36.44
Sep 27 01:00:00 - 01:59:59 5226 4.0% 1.4585.8 MB 5.4% 24.42
Sep 27 02:00:00 - 02:59:59 4515 3.5% 1.2565.0 MB 4.1% 18.50
Sep 27 03:00:00 - 03:59:59 3211 2.5% 0.8956.8 MB 3.6% 16.15
Sep 27 04:00:00 - 04:15:01 1014 0.8% 1.1314.2 MB 0.9% 16.14
TOTAL: 24:00:00 129944 100.0% 1.501.5 GB 100.0% 18.77
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1news.icm.edu.pl 2526 0 0 5 0 0 0 0 2521
2newsfeed.pionier.net.pl 156 136 0 12 0 0 0 0 8
TOTAL: 2 2682 136 0 17 0 0 0 0 2529

Unwanted newsgroups [Top 20]:

NewsgroupCount
uk.railway 66
comp.mobile.android 25
comp.sys.raspberry-pi 13
nl.comp.os.linux.techniek 10
it.tlc.cellulari.android 7
alt.comp.software.firefox 6
alt.comp.software.seamonkey 5
it.comp.os.win.windows10 2
comp.mobile.ipad 2
TOTAL: 9 136

INND Perl filter [Top 20]:

ReasonCount
Binary in non-binary group 2473
Scoring filter (8) 33
Scoring filter (9) 11
Scoring filter (10) 2
EMP (md5) 2
TOTAL: 5 2521

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
newsfeed.pionier.net.pl 8
TOTAL: 1 8
TOTAL: 1 8

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1icm 16693 14 12158 12 0 0 0%23:59:57
2poznan 19 0 14 0 0 0 0%02:21:34
3panorama 0 0 0 0 0 12919 0%23:57:48
4nask 0 0 0 0 0 8660 0%23:57:48
5okapi 0 0 0 0 0 1124 0%23:57:48
TOTAL: 5 16712 14 12172 12 0 22703 0%98:14:55
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1icm77.0 KB35.1 KB112.1 KB0.0 KB/s4.3 KB23:59:57
2poznan0.0 KB0.0 KB0.0 KB0.0 KB/s002:21:34
3panorama0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:48
4nask0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:48
5okapi0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:48
TOTAL: 577.0 KB35.1 KB112.1 KB0.0 KB/s4.3 KB98:14:55
Outgoing feeds (innfeed) by Volume

Backlog files shrunk by innfeed:

ServerSize
panorama976.7 KB
TOTAL: 1976.7 KB

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
193-34-226-225.ip51.fastwebnet.it 7 300453.0 KB 1 0 000:02:45
2web.man.lodz.pl 288 1411.7 KB 6 0 000:00:09
3isvcs01.man.lodz.pl 2 00.0 KB 0 2 000:00:00
TOTAL: 3 297 314464.7 KB 7 2 000:03:28

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.ip51.fastwebnet.it 7 300453.0 KB 1 0 000:02:45
2*.man.lodz.pl1730 1411.7 KB 6 2 000:00:24
3*.ch1.censys-scanner.com 1 00.0 KB 0 0 000:00:00
4unresolved 110 00.0 KB 0 0 000:00:18
TOTAL: 41848 314464.7 KB 7 2 000:03:28

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
93-34-226-225.ip51.fastwebnet.it 0.067 0.106 0.00000:02:45
nms2.man.lodz.pl 4.466 8.039 0.00000:00:14
172.105.9.235 0.005 0.000 0.00000:00:10
web.man.lodz.pl 1.000 1.542 0.00000:00:09
45.125.65.22 0.009 0.038 0.00000:00:03
80.111.142.213 0.013 0.025 0.00000:00:02
212.51.192.185 0.366 0.568 0.00000:00:01
71.6.134.235 0.016 0.014 0.00000:00:00
scanner-04.ch1.censys-scanner.com 0.003 0.009 0.00000:00:00
138.68.208.51 0.013 0.000 0.00000:00:00
isvcs01.man.lodz.pl 0.009 0.023 0.00000:00:00
TOTAL: 11 5.967 10.364 0.00000:03:28

Curious NNRP server explorers [Top 20]:

SystemConn
nms2.man.lodz.pl 1440
212.51.192.185 96
45.125.65.22 5
80.111.142.213 4
71.6.134.235 3
172.105.9.235 1
scanner-04.ch1.censys-scanner.com 1
138.68.208.51 1
TOTAL: 8 1551

NNRP unrecognized commands (by host):

SystemConn
71.6.134.235 7
45.125.65.22 5
138.68.208.51 1
scanner-04.ch1.censys-scanner.com 1
TOTAL: 4 14

NNRP unrecognized commands (by command):

CommandCount
#003 5
Accept: */* 1
MGLNDD_212.191.2.21_119 1
EHLO www.censys.io 1
Accept-Encoding: gzip 1
GET / HTTP/1.1 1
#023#003#023#001#023#002#001 1
#026#003#001 1
Host: 212.191.2.21:119 1
User-Agent: Mozilla/5.0 (Windows NT 10.0... 1
TOTAL: 10 14

NNRP client timeouts [Top 20]:

SystemConnPeer
45.125.65.22 5 5
TOTAL: 1 5 5

Newsgroup request counts (by category):

CategoryCountPct
1lodman 300 95.5%
2pl 14 4.5%
TOTAL: 2 314100.0%

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

NewsgroupCount
1lodman.info 300
2pl.comp.os.ms-windows.winnt 12
3pl.comp.pecet 2
TOTAL: 3 314