Daily Usenet report

Jul 22 04:15:01 -- Jul 23 04:15:01

Unknown entries from news log file:

First 12 / 12 lines (100.0%)

Jul 22 09:28:36 newsfeed nnrpd[1432748]: SERVER perl filter not defined
Jul 22 16:18:15 newsfeed overchan[1418235]: input line too long, skipping
Jul 22 16:20:04 newsfeed overchan[1418235]: input line too long, skipping
Jul 22 16:22:01 newsfeed overchan[1418235]: input line too long, skipping
Jul 22 16:23:26 newsfeed overchan[1418235]: input line too long, skipping
Jul 22 18:40:13 newsfeed overchan[1418235]: input line too long, skipping
Jul 22 18:43:33 newsfeed overchan[1418235]: input line too long, skipping
Jul 22 18:59:53 newsfeed overchan[1418235]: input line too long, skipping
Jul 22 19:01:37 newsfeed overchan[1418235]: input line too long, skipping
Jul 22 19:10:12 newsfeed overchan[1418235]: input line too long, skipping
Jul 22 20:08:00 newsfeed overchan[1418235]: input line too long, skipping
Jul 23 03:44:51 newsfeed overchan[1418235]: input line too long, skipping

Log entries by program:

Program nameLines%LinesSize%Size
inn 100848 90.1%11.6 MB 91.3%
nnrpd 7701 6.9%752.7 KB 5.8%
innd 2086 1.9%233.5 KB 1.8%
innfeed 1292 1.2%144.9 KB 1.1%
overchan 12 0.0%1.3 KB 0.0%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 6 111940 100.0%12.7 MB100.0%

History cache:

ReasonCount%Count
Do not exist 100435 98.1%
Negative hits 1716 1.7%
Positive hits 259 0.3%
Cache misses 18 0.0%
TOTAL: 4 102428 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.564 0.0%30 0.000 18.800 60.500
article cleanup00:00:00.423 0.0%100748 0.000 0.004 0.012
article logging00:00:01.833 0.0%101047 0.000 0.018 0.055
article parse00:00:01.931 0.0%631611 0.000 0.003 0.006
article write00:00:13.795 0.0%100636 0.034 0.137 3.154
artlog/artcncl00:00:00.000 0.0%29 0.000 0.000 0.000
data move00:00:00.611 0.0%819329 0.000 0.001 0.003
hisgrep/artcncl00:00:00.150 0.0%30 0.000 5.000 23.500
hishave/artcncl00:00:00.128 0.0%30 0.000 4.267 10.500
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:12:48.842 0.9%102708 2.633 7.486 34.959
history sync00:00:00.018 0.0%392 0.000 0.046 0.667
history write00:09:29.639 0.7%100740 3.482 5.655 20.151
hiswrite/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
idle23:36:22.087 98.3%714168 18.788 118.995 627.065
nntp read00:00:05.515 0.0%625307 0.004 0.009 0.017
overview write00:00:00.212 0.0%100636 0.000 0.002 0.013
perl filter00:01:21.174 0.1%100740 0.385 0.806 1.664
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:00:02.095 0.0%210929 0.003 0.010 0.022
TOTAL: 24:01:01.98124:00:29.017100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.015 0.0%9650 0.000 0.002 0.024
article prepare00:00:00.000 0.0%76 0.000 0.000 0.000
article read00:00:00.000 0.0%19 0.000 0.000 0.000
backlog stats00:00:00.023 0.0%43093 0.000 0.001 0.010
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:00.159 0.0%22434 0.000 0.007 0.041
data write00:00:00.382 0.0%12936 0.000 0.030 0.094
idle23:58:52.117100.0%43093 1059.386 2003.391 5718.905
status file00:00:00.722 0.0%333 0.000 2.168 37.000
TOTAL: 23:58:54.09623:58:53.418100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:56:28.740 99.5%4203 0.000 806.267452168.500
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.735 0.0%10168 0.000 0.072 55.455
readart00:00:00.001 0.0%4 0.000 0.250 0.500
TOTAL: 00:56:46.27700:56:29.476 99.5%----

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 84 100419 100312 3 104 99%43:27:44
2news.icm.edu.pl 42 257 10 241 6 3%15:49:12
3localhost 2 1 1 0 0 100%00:00:00
TOTAL: 3 128 100677 100323 244 110 99%59:16:56
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1newsfeed.pionier.net.pl1.4 GB117.5 KB412.8 KB1.4 GB 99%14.7 KB
2news.icm.edu.pl468.4 KB12.5 KB60.6 KB541.5 KB 86%33.8 KB
3localhost1.3 KB0.0 KB0.0 KB1.3 KB100%1.3 KB
TOTAL: 31.4 GB130.0 KB473.4 KB1.4 GB 99%14.7 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Jul 22 04:15:01 - 04:59:59 2004 2.0% 0.7456.0 MB 3.9% 21.25
Jul 22 05:00:00 - 05:59:59 2338 2.3% 0.6572.0 MB 5.0% 20.49
Jul 22 06:00:00 - 06:59:59 2214 2.2% 0.6163.9 MB 4.4% 18.19
Jul 22 07:00:00 - 07:59:59 3788 3.8% 1.0584.0 MB 5.8% 23.88
Jul 22 08:00:00 - 08:59:59 2439 2.4% 0.6844.9 MB 3.1% 12.77
Jul 22 09:00:00 - 09:59:59 2619 2.6% 0.7344.4 MB 3.1% 12.63
Jul 22 10:00:00 - 10:59:59 3633 3.6% 1.0145.1 MB 3.1% 12.82
Jul 22 11:00:00 - 11:59:59 2931 2.9% 0.8144.4 MB 3.1% 12.63
Jul 22 12:00:00 - 12:59:59 5955 5.9% 1.65101.3 MB 7.0% 28.83
Jul 22 13:00:00 - 13:59:59 4208 4.2% 1.17141.6 MB 9.8% 40.29
Jul 22 14:00:00 - 14:59:59 4292 4.3% 1.1968.6 MB 4.8% 19.51
Jul 22 15:00:00 - 15:59:59 3480 3.5% 0.9752.5 MB 3.7% 14.94
Jul 22 16:00:00 - 16:59:59 4885 4.9% 1.3667.0 MB 4.7% 19.05
Jul 22 17:00:00 - 17:59:59 3719 3.7% 1.0356.4 MB 3.9% 16.03
Jul 22 18:00:00 - 18:59:59 3235 3.2% 0.9047.1 MB 3.3% 13.40
Jul 22 19:00:00 - 19:59:59 3975 4.0% 1.1054.7 MB 3.8% 15.55
Jul 22 20:00:00 - 20:59:59 7869 7.8% 2.1952.1 MB 3.6% 14.83
Jul 22 21:00:00 - 21:59:59 12281 12.2% 3.4191.0 MB 6.3% 25.90
Jul 22 22:00:00 - 22:59:59 4633 4.6% 1.2951.3 MB 3.6% 14.60
Jul 22 23:00:00 - 23:59:59 4190 4.2% 1.1634.7 MB 2.4% 9.87
Jul 23 00:00:00 - 00:59:59 2731 2.7% 0.7636.9 MB 2.6% 10.48
Jul 23 01:00:00 - 01:59:59 5241 5.2% 1.4653.6 MB 3.7% 15.25
Jul 23 02:00:00 - 02:59:59 5152 5.1% 1.4343.4 MB 3.0% 12.34
Jul 23 03:00:00 - 03:59:59 2388 2.4% 0.6629.1 MB 2.0% 8.26
Jul 23 04:00:00 - 04:15:01 208 0.2% 0.232.5 MB 0.2% 2.84
TOTAL: 24:00:00 100408 100.0% 1.161.4 GB 100.0% 17.05
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1newsfeed.pionier.net.pl 405 99 0 5 0 0 0 0 301
2news.icm.edu.pl 6 0 0 1 0 0 0 0 5
TOTAL: 2 411 99 0 6 0 0 0 0 306

Unwanted newsgroups [Top 20]:

NewsgroupCount
uk.railway 76
comp.sys.raspberry-pi 5
it.comp.os.win.windows10 4
de.rec.sf.startrek 4
alt.comp.software.seamonkey 4
it.tlc.cellulari.android 3
it.discussioni.energia 2
comp.mobile.android 1
TOTAL: 8 99

INND Perl filter [Top 20]:

ReasonCount
Binary in non-binary group 3
Scoring filter (9) 1
HTML post 1
TOTAL: 3 5

Miscellaneous innd statistics [Top 10]:

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

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1icm 12758 12 9547 7 0 0 0%23:57:49
2panorama 0 0 0 0 0 9649 0%23:57:48
3nask 0 0 0 0 0 6570 0%23:57:48
4okapi 0 0 0 0 0 802 0%23:57:48
5poznan 15 0 10 0 0 0 0%01:31:21
TOTAL: 5 12773 12 9557 7 0 17021 0%97:22:34
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1icm43.5 KB16.0 KB59.6 KB0.0 KB/s3.1 KB23:57:49
2panorama0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:48
3nask0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:48
4okapi0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:48
5poznan0.0 KB0.0 KB0.0 KB0.0 KB/s001:31:21
TOTAL: 543.5 KB16.0 KB59.6 KB0.0 KB/s3.1 KB97:22:34
Outgoing feeds (innfeed) by Volume

Backlog files shrunk by innfeed:

ServerSize
panorama976.8 KB
TOTAL: 1976.8 KB

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1web.man.lodz.pl 288 42.8 KB 2 0 000:00:08
2isvcs01.man.lodz.pl 1 00.0 KB 0 1 000:00:00
TOTAL: 2 289 42.8 KB 2 1 000:56:46

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.man.lodz.pl1729 42.8 KB 2 1 000:00:21
2unresolved 110 00.0 KB 0 0 000:00:15
3*.ch1.censys-scanner.com 1 00.0 KB 0 0 000:00:00
4*.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:01
5*.toya.net.pl 2 00.0 KB 0 0 000:25:58
6*.icpnet.pl 1 00.0 KB 0 0 000:30:08
TOTAL: 61844 42.8 KB 2 1 000:56:46

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
c138-3.icpnet.pl 0.004 0.012 0.00000:30:08
staticline-31-182-253-249.toya.net.pl 0.015 0.024 0.00000:25:58
nms2.man.lodz.pl 2.448 20.423 0.00000:00:12
192.241.207.100 0.000 0.014 0.00000:00:09
web.man.lodz.pl 0.454 4.251 0.00000:00:08
80.111.142.213 0.011 0.053 0.00000:00:02
healthy.monitoring.internet-measurement.com 0.000 0.016 0.00000:00:01
212.51.192.185 0.170 1.336 0.00000:00:00
71.6.134.231 0.003 0.049 0.00000:00:00
85.92.116.143 0.007 0.040 0.00000:00:00
scanner-25.ch1.censys-scanner.com 0.003 0.014 0.00000:00:00
194.165.16.10 0.006 0.009 0.00000:00:00
198.199.114.28 0.004 0.015 0.00000:00:00
162.243.146.24 0.006 0.010 0.00000:00:00
isvcs01.man.lodz.pl 0.000 0.018 0.00000:00:00
? 0.004 0.011 0.00000:00:00
TOTAL: 16 3.135 26.295 0.00000:56:46

Curious NNRP server explorers [Top 20]:

SystemConn
nms2.man.lodz.pl 1440
212.51.192.185 96
80.111.142.213 4
71.6.134.231 3
85.92.116.143 3
staticline-31-182-253-249.toya.net.pl 2
scanner-25.ch1.censys-scanner.com 1
198.199.114.28 1
162.243.146.24 1
194.165.16.10 1
192.241.207.100 1
healthy.monitoring.internet-measurement.com 1
c138-3.icpnet.pl 1
TOTAL: 13 1555

NNRP gethostbyaddr failures [Top 20]:

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

NNRP unrecognized commands (by host):

SystemConn
71.6.134.231 8
85.92.116.143 3
scanner-25.ch1.censys-scanner.com 1
198.199.114.28 1
162.243.146.24 1
194.165.16.10 1
TOTAL: 6 15

NNRP unrecognized commands (by command):

CommandCount
#003 4
MGLNDD_212.191.2.21_119 2
GET / HTTP/1.1 1
Accept: */* 1
User-Agent: Mozilla/5.0 (Windows NT 10.0... 1
#026#003#001 1
)Ec#024G1…#033å 1
#023#003#023#001#023#002#001 1
Host: 212.191.2.21:119 1
EHLO www.censys.io 1
Accept-Encoding: gzip 1
TOTAL: 11 15

NNRP client timeouts [Top 20]:

SystemConnPeer
85.92.116.143 3 3
194.165.16.10 1 1
c138-3.icpnet.pl 1 0
TOTAL: 3 5 4

Newsgroup request counts (by category):

CategoryCountPct
1pl 4100.0%
TOTAL: 1 4100.0%

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

NewsgroupCount
1pl.comp.os.ms-windows.winnt 4
TOTAL: 1 4