Daily Usenet report

Aug 9 04:15:01 -- Aug 10 04:15:01

Unknown entries from news log file:

First 20 / 20 lines (100.0%)

Aug 9 09:36:51 newsfeed nnrpd[849720]: SERVER perl filter not defined
Aug 9 11:07:39 newsfeed overchan[833229]: input line too long, skipping
Aug 9 11:07:58 newsfeed overchan[833229]: input line too long, skipping
Aug 9 15:06:18 newsfeed nnrpd[864393]: SERVER perl filter not defined
Aug 9 17:17:30 newsfeed overchan[833229]: input line too long, skipping
Aug 9 17:42:49 newsfeed overchan[833229]: input line too long, skipping
Aug 9 17:55:45 newsfeed overchan[833229]: input line too long, skipping
Aug 9 17:58:23 newsfeed overchan[833229]: input line too long, skipping
Aug 9 18:36:09 newsfeed overchan[833229]: input line too long, skipping
Aug 9 18:49:30 newsfeed overchan[833229]: input line too long, skipping
Aug 9 19:09:21 newsfeed overchan[833229]: input line too long, skipping
Aug 9 19:58:42 newsfeed overchan[833229]: input line too long, skipping
Aug 9 20:01:20 newsfeed nnrpd[877529]: SERVER perl filter not defined
Aug 9 20:11:42 newsfeed overchan[833229]: input line too long, skipping
Aug 9 21:09:05 newsfeed overchan[833229]: input line too long, skipping
Aug 9 21:16:06 newsfeed overchan[833229]: input line too long, skipping
Aug 9 21:26:03 newsfeed overchan[833229]: input line too long, skipping
Aug 9 21:26:20 newsfeed overchan[833229]: input line too long, skipping
Aug 9 21:29:17 newsfeed overchan[833229]: input line too long, skipping
Aug 9 22:30:07 newsfeed overchan[833229]: input line too long, skipping

Log entries by program:

Program nameLines%LinesSize%Size
inn 231934 95.4%25.9 MB 95.6%
nnrpd 7643 3.1%784.3 KB 2.8%
innd 2225 0.9%282.4 KB 1.0%
innfeed 1389 0.6%140.8 KB 0.5%
overchan 19 0.0%2.2 KB 0.0%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 6 243211 100.0%27.0 MB100.0%

History cache:

ReasonCount%Count
Do not exist 231380 98.9%
Negative hits 2023 0.9%
Positive hits 394 0.2%
Cache misses 40 0.0%
TOTAL: 4 233837 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:01.285 0.0%57 0.000 22.544 77.250
article cleanup00:00:01.289 0.0%231831 0.001 0.006 0.014
article logging00:00:04.701 0.0%232060 0.011 0.020 0.054
article parse00:00:07.735 0.0%1481933 0.002 0.005 0.010
article write00:00:26.497 0.0%231728 0.051 0.114 6.955
artlog/artcncl00:00:00.002 0.0%54 0.000 0.037 0.333
data move00:00:01.297 0.0%2004854 0.000 0.001 0.003
hisgrep/artcncl00:00:00.340 0.0%57 0.000 5.965 12.000
hishave/artcncl00:00:00.129 0.0%57 0.000 2.263 7.750
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:06:23.148 0.4%234207 0.215 1.636 33.064
history sync00:00:00.012 0.0%299 0.000 0.040 1.000
history write00:13:56.130 1.0%231797 1.087 3.607 34.038
hiswrite/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
idle23:34:30.844 98.2%1646026 13.997 51.561 533.811
nntp read00:00:17.863 0.0%1455742 0.006 0.012 0.022
overview write00:00:00.647 0.0%231728 0.000 0.003 0.013
perl filter00:03:40.165 0.3%231797 0.568 0.950 1.295
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:00:06.034 0.0%473790 0.006 0.013 0.022
TOTAL: 24:00:17.99623:59:38.118100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.022 0.0%10352 0.000 0.002 0.032
article prepare00:00:00.000 0.0%556 0.000 0.000 0.000
article read00:00:00.001 0.0%139 0.000 0.007 1.000
backlog stats00:00:00.033 0.0%52182 0.000 0.001 0.010
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:00.227 0.0%26252 0.000 0.009 0.131
data write00:00:00.601 0.0%16091 0.000 0.037 0.119
idle23:59:43.397100.0%52182 370.188 1655.425 5612.748
status file00:00:00.440 0.0%367 0.000 1.199 47.000
TOTAL: 23:59:45.58423:59:44.721100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:22.993 57.9%4176 0.000 5.506 3875.333
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.123 0.3%10085 0.000 0.012 0.500
TOTAL: 00:00:39.72300:00:23.116 58.2%----

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 70 231569 231479 2 88 99%42:51:42
2news.icm.edu.pl 32 403 36 351 16 8%18:18:17
3localhost 4 3 3 0 0 100%00:00:00
TOTAL: 3 106 231975 231518 353 104 99%61:09:59
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1newsfeed.pionier.net.pl3.4 GB792.0 KB926.0 KB3.4 GB 99%15.6 KB
2news.icm.edu.pl882.0 KB30.0 KB298.7 KB1.2 MB 72%23.3 KB
3localhost5.0 KB0.0 KB0.0 KB5.0 KB100%1.7 KB
TOTAL: 33.4 GB822.0 KB1.2 MB3.4 GB 99%15.6 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Aug 9 04:15:01 - 04:59:59 1866 0.8% 0.6916.9 MB 0.5% 6.40
Aug 9 05:00:00 - 05:59:59 2466 1.1% 0.6921.9 MB 0.6% 6.23
Aug 9 06:00:00 - 06:59:59 6076 2.6% 1.6984.1 MB 2.4% 23.93
Aug 9 07:00:00 - 07:59:59 4436 1.9% 1.2380.2 MB 2.3% 22.82
Aug 9 08:00:00 - 08:59:59 5492 2.4% 1.53111.9 MB 3.2% 31.84
Aug 9 09:00:00 - 09:59:59 14003 6.0% 3.89283.0 MB 8.0% 80.51
Aug 9 10:00:00 - 10:59:59 21390 9.2% 5.94309.2 MB 8.8% 87.96
Aug 9 11:00:00 - 11:59:59 18826 8.1% 5.23323.1 MB 9.2% 91.91
Aug 9 12:00:00 - 12:59:59 18860 8.1% 5.24332.5 MB 9.4% 94.58
Aug 9 13:00:00 - 13:59:59 17368 7.5% 4.82259.3 MB 7.4% 73.76
Aug 9 14:00:00 - 14:59:59 10687 4.6% 2.97215.5 MB 6.1% 61.29
Aug 9 15:00:00 - 15:59:59 4777 2.1% 1.3360.1 MB 1.7% 17.11
Aug 9 16:00:00 - 16:59:59 5126 2.2% 1.4275.8 MB 2.2% 21.56
Aug 9 17:00:00 - 17:59:59 4784 2.1% 1.3381.3 MB 2.3% 23.12
Aug 9 18:00:00 - 18:59:59 4716 2.0% 1.3158.2 MB 1.7% 16.56
Aug 9 19:00:00 - 19:59:59 13350 5.8% 3.71189.3 MB 5.4% 53.85
Aug 9 20:00:00 - 20:59:59 15134 6.5% 4.20202.9 MB 5.8% 57.71
Aug 9 21:00:00 - 21:59:59 15842 6.8% 4.40194.9 MB 5.5% 55.44
Aug 9 22:00:00 - 22:59:59 16992 7.3% 4.72210.0 MB 6.0% 59.74
Aug 9 23:00:00 - 23:59:59 15707 6.8% 4.36235.7 MB 6.7% 67.03
Aug 10 00:00:00 - 00:59:59 3217 1.4% 0.8948.7 MB 1.4% 13.84
Aug 10 01:00:00 - 01:59:59 3361 1.5% 0.9346.0 MB 1.3% 13.09
Aug 10 02:00:00 - 02:59:59 4477 1.9% 1.2455.9 MB 1.6% 15.91
Aug 10 03:00:00 - 03:59:59 2108 0.9% 0.5919.9 MB 0.6% 5.67
Aug 10 04:00:00 - 04:15:01 487 0.2% 0.545.3 MB 0.2% 6.05
TOTAL: 24:00:00 231548 100.0% 2.683.4 GB 100.0% 41.74
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1newsfeed.pionier.net.pl 318 55 0 33 0 0 0 0 230
2news.icm.edu.pl 14 0 0 1 0 0 0 0 13
TOTAL: 2 332 55 0 34 0 0 0 0 243

Unwanted newsgroups [Top 20]:

NewsgroupCount
comp.mobile.android 15
uk.railway 15
comp.sys.raspberry-pi 13
it.tlc.cellulari.android 6
de.comp.lang.vbclassic 2
alt.comp.software.seamonkey 2
it.comp.os.linux.ubuntu 1
de.rec.sf.startrek 1
TOTAL: 8 55

INND Perl filter [Top 20]:

ReasonCount
Binary in non-binary group 12
EMP (md5) 1
TOTAL: 2 13

Miscellaneous innd statistics [Top 10]:

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

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1icm 15971 119 10093 19 0 0 0%24:04:03
2poznan 47 1 34 0 0 0 2%04:27:04
3okapi 0 0 0 0 0 575 0%24:05:32
4nask 0 0 0 0 0 6856 0%24:05:32
5panorama 0 0 0 0 0 10384 0%24:05:32
TOTAL: 5 16018 120 10127 19 0 17815 0%100:47:43
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1icm396.5 KB68.6 KB465.1 KB0.0 KB/s3.4 KB24:04:03
2poznan13.6 KB0.0 KB13.6 KB0.0 KB/s13.6 KB04:27:04
3okapi0.0 KB0.0 KB0.0 KB0.0 KB/s024:05:32
4nask0.0 KB0.0 KB0.0 KB0.0 KB/s024:05:32
5panorama0.0 KB0.0 KB0.0 KB0.0 KB/s024:05:32
TOTAL: 5410.1 KB68.6 KB478.7 KB0.0 KB/s3.4 KB100:47:43
Outgoing feeds (innfeed) by Volume

Backlog files shrunk by innfeed:

ServerSize
panorama976.7 KB
TOTAL: 1976.7 KB

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1194.165.16.73 1 00.0 KB 0 0 000:00:00
2pc-tom.man.lodz.pl 1 00.0 KB 0 0 000:00:11
394.102.61.41 1 00.0 KB 0 0 000:00:00
4104.131.144.17 1 00.0 KB 0 0 000:00:00
5web.man.lodz.pl 287 00.0 KB 0 0 000:00:08
6212.51.192.185 96 00.0 KB 0 0 000:00:00
780.111.142.213 4 00.0 KB 0 0 000:00:02
8nms2.man.lodz.pl1440 00.0 KB 0 0 000:00:13
9isvcs01.man.lodz.pl 3 00.0 KB 0 3 000:00:00
10scanner-08.ch1.censys-scanner.com 1 00.0 KB 0 0 000:00:00
11wholesome.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:01
TOTAL: 111836 00.0 KB 0 3 000:00:40

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.man.lodz.pl1731 00.0 KB 0 3 000:00:33
2unresolved 103 00.0 KB 0 0 000:00:03
3*.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:01
4*.ch1.censys-scanner.com 1 00.0 KB 0 0 000:00:00
TOTAL: 41836 00.0 KB 0 3 000:00:40

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
nms2.man.lodz.pl 3.503 6.943 0.00000:00:13
pc-tom.man.lodz.pl 0.000 0.005 0.00000:00:11
web.man.lodz.pl 0.775 1.348 0.00000:00:08
80.111.142.213 0.025 0.014 0.00000:00:02
wholesome.monitoring.internet-measurement.com 0.005 0.005 0.00000:00:01
212.51.192.185 0.248 0.445 0.00000:00:00
scanner-08.ch1.censys-scanner.com 0.014 0.000 0.00000:00:00
194.165.16.73 0.002 0.004 0.00000:00:00
104.131.144.17 0.006 0.000 0.00000:00:00
isvcs01.man.lodz.pl 0.025 0.006 0.00000:00:00
94.102.61.41 0.002 0.005 0.00000:00:00
TOTAL: 11 4.605 8.775 0.00000:00:40

NNRP unrecognized commands (by host):

SystemConn
94.102.61.41 5
194.165.16.73 1
104.131.144.17 1
scanner-08.ch1.censys-scanner.com 1
TOTAL: 4 8

NNRP unrecognized commands (by command):

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

NNRP client timeouts [Top 20]:

SystemConnPeer
194.165.16.73 1 1
TOTAL: 1 1 1