Daily Usenet report

Oct 3 04:15:02 -- Oct 4 04:15:02

Unknown entries from news log file:

First 30 / 30 lines (100.0%)

Oct 3 08:21:41 newsfeed overchan[8956]: input line too long, skipping
Oct 3 09:09:39 newsfeed nnrpd[22669]: SERVER perl filter not defined
Oct 3 10:25:41 newsfeed overchan[8956]: input line too long, skipping
Oct 3 10:35:37 newsfeed overchan[8956]: input line too long, skipping
Oct 3 11:41:02 newsfeed overchan[8956]: input line too long, skipping
Oct 3 16:00:36 newsfeed overchan[8956]: input line too long, skipping
Oct 3 16:14:06 newsfeed overchan[8956]: input line too long, skipping
Oct 3 16:50:21 newsfeed overchan[8956]: input line too long, skipping
Oct 3 16:56:53 newsfeed overchan[8956]: input line too long, skipping
Oct 3 17:17:43 newsfeed overchan[8956]: input line too long, skipping
Oct 3 17:34:15 newsfeed overchan[8956]: input line too long, skipping
Oct 3 17:37:16 newsfeed overchan[8956]: input line too long, skipping
Oct 3 17:59:36 newsfeed overchan[8956]: input line too long, skipping
Oct 3 18:12:00 newsfeed overchan[8956]: input line too long, skipping
Oct 3 19:33:13 newsfeed overchan[8956]: input line too long, skipping
Oct 3 20:19:05 newsfeed overchan[8956]: input line too long, skipping
Oct 3 20:51:27 newsfeed overchan[8956]: input line too long, skipping
Oct 3 21:32:12 newsfeed overchan[8956]: input line too long, skipping
Oct 3 21:46:28 newsfeed overchan[8956]: input line too long, skipping
Oct 3 21:54:35 newsfeed overchan[8956]: input line too long, skipping
Oct 3 22:38:56 newsfeed overchan[8956]: input line too long, skipping
Oct 3 22:54:44 newsfeed overchan[8956]: input line too long, skipping
Oct 3 23:01:35 newsfeed overchan[8956]: input line too long, skipping
Oct 3 23:38:44 newsfeed overchan[8956]: input line too long, skipping
Oct 3 23:50:08 newsfeed overchan[8956]: input line too long, skipping
Oct 4 00:09:58 newsfeed overchan[8956]: input line too long, skipping
Oct 4 01:07:47 newsfeed overchan[8956]: input line too long, skipping
Oct 4 03:34:37 newsfeed overchan[8956]: input line too long, skipping
Oct 4 03:40:29 newsfeed overchan[8956]: input line too long, skipping
Oct 4 03:50:13 newsfeed overchan[8956]: input line too long, skipping

Log entries by program:

Program nameLines%LinesSize%Size
inn 587497 90.7%64.8 MB 89.9%
innfeed 47520 7.3%5.5 MB 7.7%
innd 8649 1.3%1.3 MB 1.9%
nnrpd 4221 0.7%418.0 KB 0.6%
overchan 30 0.0%5.4 KB 0.0%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 6 647918 100.0%72.1 MB100.0%

History cache:

ReasonCount%Count
Do not exist 582346 99.6%
Negative hits 2376 0.4%
Positive hits 209 0.0%
Cache misses 36 0.0%
TOTAL: 4 584967 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:01.191 0.0%94 0.000 12.670 169.000
article cleanup00:00:09.392 0.0%586773 0.011 0.016 0.023
article logging00:00:31.498 0.0%587290 0.044 0.054 0.064
article parse00:19:30.865 1.4%36670807 0.015 0.032 0.043
article write00:08:17.685 0.6%586515 0.650 0.849 1.537
artlog/artcncl00:00:00.003 0.0%93 0.000 0.032 0.500
data move00:00:39.551 0.0%40943181 0.001 0.001 0.001
hisgrep/artcncl00:00:00.477 0.0%87 0.000 5.483 164.000
hishave/artcncl00:00:00.016 0.0%94 0.000 0.170 2.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:07:41.124 0.5%589599 0.482 0.782 6.282
history sync00:00:00.032 0.0%291 0.000 0.110 1.000
history write00:07:21.134 0.5%586757 0.522 0.752 8.958
hiswrite/artcncl00:00:00.001 0.0%7 0.000 0.143 1.000
idle21:24:40.907 89.2%36425358 1.013 2.116 3.751
nntp read00:30:20.572 2.1%36399795 0.032 0.050 0.061
overview write00:00:03.615 0.0%586515 0.003 0.006 0.009
perl filter01:08:23.424 4.7%586757 5.598 6.993 8.962
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:00:34.699 0.0%1186349 0.024 0.029 0.037
TOTAL: 24:00:01.53623:48:16.186 99.2%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.128 0.0%51076 0.000 0.003 0.009
article prepare00:00:00.000 0.0%1216 0.000 0.000 0.000
article read00:00:03.991 0.0%304 0.000 13.128 162.000
backlog stats00:00:00.128 0.0%116505 0.000 0.001 0.005
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:01.086 0.0%56624 0.005 0.019 0.048
data write00:00:02.833 0.0%43377 0.025 0.065 0.122
idle23:53:15.094 99.9%116505 518.328 738.124 1134.762
status file00:00:48.159 0.1%17222 0.847 2.796 110.936
TOTAL: 23:54:17.79023:54:11.419100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:48.985 69.3%3063 0.000 15.992 5387.667
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.248 0.4%6833 0.000 0.036 1.000
readart00:00:00.004 0.0%60 0.000 0.067 0.500
TOTAL: 00:01:10.70100:00:49.237 69.6%----

Control commands to INND:

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

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1newsfeed.pionier.net.pl 124 586666 586495 0 171 99%70:36:31
2news.icm.edu.pl 42 248 20 141 87 8%14:45:04
3localhost 1442 1 1 0 0 100%00:00:00
TOTAL: 3 1608 586915 586516 141 258 99%85:21:35
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1newsfeed.pionier.net.pl267.8 GB1002.1 KB1.4 MB267.8 GB 99%478.6 KB
2news.icm.edu.pl1004.8 KB30.2 KB2.2 MB3.2 MB 30%30.4 KB
3localhost1.5 KB0.0 KB0.0 KB1.5 KB100%1.5 KB
TOTAL: 3267.8 GB1.0 MB3.6 MB267.8 GB 99%478.5 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Oct 3 04:15:02 - 04:59:59 15842 2.7% 5.877.2 GB 2.7%2816.73
Oct 3 05:00:00 - 05:59:59 20270 3.5% 5.639.2 GB 3.4%2672.07
Oct 3 06:00:00 - 06:59:59 21669 3.7% 6.0210.4 GB 3.9%3024.43
Oct 3 07:00:00 - 07:59:59 22428 3.8% 6.2311.1 GB 4.1%3241.17
Oct 3 08:00:00 - 08:59:59 21761 3.7% 6.049.5 GB 3.6%2780.57
Oct 3 09:00:00 - 09:59:59 27411 4.7% 7.6111.8 GB 4.4%3435.02
Oct 3 10:00:00 - 10:59:59 28574 4.9% 7.9411.5 GB 4.3%3343.07
Oct 3 11:00:00 - 11:59:59 26151 4.5% 7.2611.2 GB 4.2%3261.15
Oct 3 12:00:00 - 12:59:59 25687 4.4% 7.1411.8 GB 4.4%3423.68
Oct 3 13:00:00 - 13:59:59 26967 4.6% 7.4912.7 GB 4.7%3689.95
Oct 3 14:00:00 - 14:59:59 31187 5.3% 8.6614.2 GB 5.3%4139.06
Oct 3 15:00:00 - 15:59:59 27350 4.7% 7.6012.3 GB 4.6%3577.64
Oct 3 16:00:00 - 16:59:59 28444 4.8% 7.9012.2 GB 4.6%3559.78
Oct 3 17:00:00 - 17:59:59 28736 4.9% 7.9813.3 GB 5.0%3875.88
Oct 3 18:00:00 - 18:59:59 25456 4.3% 7.0710.8 GB 4.0%3151.61
Oct 3 19:00:00 - 19:59:59 25189 4.3% 7.0010.5 GB 3.9%3069.32
Oct 3 20:00:00 - 20:59:59 27015 4.6% 7.5011.3 GB 4.2%3298.47
Oct 3 21:00:00 - 21:59:59 25152 4.3% 6.9910.3 GB 3.9%3012.65
Oct 3 22:00:00 - 22:59:59 22194 3.8% 6.1710.5 GB 3.9%3060.86
Oct 3 23:00:00 - 23:59:59 20463 3.5% 5.6810.0 GB 3.7%2917.98
Oct 4 00:00:00 - 00:59:59 20426 3.5% 5.6710.2 GB 3.8%2976.40
Oct 4 01:00:00 - 01:59:59 21070 3.6% 5.8511.6 GB 4.3%3370.52
Oct 4 02:00:00 - 02:59:59 21434 3.7% 5.9511.2 GB 4.2%3267.78
Oct 4 03:00:00 - 03:59:59 20027 3.4% 5.5610.6 GB 3.9%3085.80
Oct 4 04:00:00 - 04:15:02 5723 1.0% 6.343.0 GB 1.1%3529.30
TOTAL: 24:00:00 586626 100.0% 6.79268.6 GB 100.0%3259.59
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1newsfeed.pionier.net.pl 691 151 0 14 3 0 0 0 523
2news.icm.edu.pl 87 0 0 2 0 0 0 0 85
TOTAL: 2 778 151 0 16 3 0 0 0 608

Unwanted newsgroups [Top 20]:

NewsgroupCount
uk.railway 125
it.comp.os.win.windows10 8
it.tlc.cellulari.android 6
nl.comp.os.linux.techniek 2
comp.mobile.android 2
it.comp.os.linux.ubuntu 1
nl.comp.3d-printen 1
nl.actueel 1
comp.sys.raspberry-pi 1
nl.gezondheid.alternatief-genezen 1
nl.wetenschap.regulier 1
nl.comp.sys.android 1
it.comp.virtualizzazione 1
TOTAL: 13 151

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

GroupsCount
pl.praca.oferowana 3
TOTAL: 1 3

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 82
Binary in non-binary group 6
TOTAL: 2 88

Miscellaneous innd statistics [Top 10]:

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

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1icm 20879 58 13162 5 0 0 0%23:59:44
2panorama 40723 39 12095 45 0 39050 0%23:59:58
3nask 0 0 0 0 0 9392 0%23:57:47
4okapi 0 0 0 0 0 656 0%23:57:47
5poznan 19 0 15 0 0 0 0%01:46:43
TOTAL: 5 61621 97 25272 50 0 49098 0%97:41:59
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1icm239.6 KB14.6 KB254.2 KB0.0 KB/s4.0 KB23:59:44
2panorama111.8 KB332.4 KB444.2 KB0.0 KB/s5.3 KB23:59:58
3nask0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:47
4okapi0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:47
5poznan0.0 KB0.0 KB0.0 KB0.0 KB/s001:46:43
TOTAL: 5351.4 KB347.0 KB698.4 KB0.0 KB/s4.8 KB97:41:59
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1web.man.lodz.pl 292 6066.9 KB 24 0 000:00:18
2isvcs01.man.lodz.pl 1 00.0 KB 0 1 000:00:00
TOTAL: 2 293 6066.9 KB 24 1 000:01:10

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.man.lodz.pl 581 6066.9 KB 24 1 000:00:22
2*.threatsinkhole.com 1 00.0 KB 0 0 000:00:00
3unresolved 100 00.0 KB 0 0 000:00:46
4*.security.ipip.net 1 00.0 KB 0 0 000:00:00
TOTAL: 4 683 6066.9 KB 24 1 000:01:10

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
80.111.142.213 0.022 0.066 0.00000:00:45
web.man.lodz.pl 1.726 3.601 0.00000:00:18
mon.man.lodz.pl 1.569 3.061 0.00000:00:03
212.51.192.185 0.560 1.001 0.00000:00:01
scan-141.security.ipip.net 0.009 0.009 0.00000:00:00
isvcs01.man.lodz.pl 0.015 0.018 0.00000:00:00
winnti-scanner-victims-will-be-notified.threatsinkhole.com 0.011 0.007 0.00000:00:00
TOTAL: 7 3.912 7.763 0.00000:01:10

Curious NNRP server explorers [Top 20]:

SystemConn
mon.man.lodz.pl 288
212.51.192.185 96
80.111.142.213 4
winnti-scanner-victims-will-be-notified.threatsinkhole.com 1
scan-141.security.ipip.net 1
TOTAL: 5 390

NNRP unrecognized commands (by host):

SystemConn
scan-141.security.ipip.net 4
TOTAL: 1 4

NNRP unrecognized commands (by command):

CommandCount
GET / HTTP/1.1 1
User-Agent: HTTP Banner Detection (https... 1
Host: 212.191.2.21:119 1
Connection: close 1
TOTAL: 4 4

Newsgroup request counts (by category):

CategoryCountPct
1pl 60100.0%
TOTAL: 1 60100.0%

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

NewsgroupCount
1pl.comp.pecet 58
2pl.comp.os.ms-windows.winnt 2
TOTAL: 2 60