Daily Usenet report

Dec 2 04:15:02 -- Dec 3 04:15:01

Unknown entries from news log file:

First 22 / 22 lines (100.0%)

Dec 2 06:32:20 newsfeed overchan[1010291]: input line too long, skipping
Dec 2 12:14:23 newsfeed pgpverify[1033923]: pgpverify: /usr/bin/gpg1: no such file
Dec 2 12:41:39 newsfeed overchan[1010291]: input line too long, skipping
Dec 2 12:42:01 newsfeed overchan[1010291]: input line too long, skipping
Dec 2 12:45:51 newsfeed overchan[1010291]: input line too long, skipping
Dec 2 13:24:20 newsfeed nnrpd[1045574]: SERVER perl filter not defined
Dec 2 13:25:29 newsfeed nnrpd[1045699]: SERVER perl filter not defined
Dec 2 13:27:25 newsfeed nnrpd[1045720]: SERVER perl filter not defined
Dec 2 13:54:30 newsfeed nnrpd[1046967]: SERVER perl filter not defined
Dec 2 15:41:36 newsfeed nnrpd[1052152]: SERVER perl filter not defined
Dec 2 16:39:45 newsfeed overchan[1010291]: input line too long, skipping
Dec 2 18:09:43 newsfeed nnrpd[1058936]: SERVER perl filter not defined
Dec 2 18:15:57 newsfeed overchan[1010291]: input line too long, skipping
Dec 2 18:51:28 newsfeed nnrpd[1061068]: SERVER perl filter not defined
Dec 2 19:18:45 newsfeed overchan[1010291]: input line too long, skipping
Dec 2 19:42:04 newsfeed nnrpd[1063460]: SERVER perl filter not defined
Dec 2 20:01:25 newsfeed overchan[1010291]: input line too long, skipping
Dec 2 22:31:01 newsfeed nnrpd[1071444]: SERVER perl filter not defined
Dec 2 22:56:40 newsfeed nnrpd[1073020]: SERVER perl filter not defined
Dec 2 23:46:18 newsfeed overchan[1010291]: input line too long, skipping
Dec 3 00:11:47 newsfeed nnrpd[1076791]: SERVER perl filter not defined
Dec 3 02:03:12 newsfeed overchan[1010291]: input line too long, skipping

Log entries by program:

Program nameLines%LinesSize%Size
inn 841505 95.6%92.5 MB 95.0%
innfeed 24273 2.8%2.9 MB 3.0%
innd 11011 1.3%1.7 MB 1.7%
nnrpd 3397 0.4%334.6 KB 0.3%
controlchan 12 0.0%2.8 KB 0.0%
overchan 11 0.0%1.9 KB 0.0%
pgpverify 1 0.0%0.2 KB 0.0%
TOTAL: 7 880210 100.0%97.4 MB100.0%

History cache:

ReasonCount%Count
Do not exist 835929 99.7%
Negative hits 2486 0.3%
Positive hits 217 0.0%
Cache misses 21 0.0%
TOTAL: 4 838653 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.686 0.0%53 0.000 12.943 69.500
article cleanup00:00:05.339 0.0%842956 0.004 0.006 0.011
article logging00:00:18.014 0.0%843286 0.014 0.021 0.029
article parse00:09:41.991 0.7%157404874 0.003 0.004 0.004
article write00:06:24.437 0.4%842796 0.272 0.456 0.599
artlog/artcncl00:00:00.000 0.0%52 0.000 0.000 0.000
data move00:01:21.694 0.1%164014562 0.000 0.000 0.001
hisgrep/artcncl00:00:00.122 0.0%53 0.000 2.302 12.500
hishave/artcncl00:00:00.003 0.0%53 0.000 0.057 0.500
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:04:30.174 0.3%845819 0.177 0.319 2.194
history sync00:00:00.006 0.0%290 0.000 0.021 0.500
history write00:14:51.447 1.0%842950 0.240 1.058 14.659
hiswrite/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
idle21:44:36.933 90.6%154963632 0.398 0.505 0.723
nntp read00:34:40.033 2.4%156854674 0.011 0.013 0.015
overview write00:00:02.382 0.0%842796 0.001 0.003 0.005
perl filter00:42:02.913 2.9%842950 2.334 2.993 3.695
python filter00:00:00.000 0.0%0 0.000 0.000 0.000
site send00:00:21.378 0.0%1694727 0.010 0.013 0.017
TOTAL: 24:00:00.82623:38:57.552 98.5%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.040 0.0%29551 0.000 0.001 0.012
article prepare00:00:00.000 0.0%3612 0.000 0.000 0.000
article read00:00:09.349 0.0%935 0.000 9.999 46.000
backlog stats00:00:00.039 0.0%82133 0.000 0.000 0.004
callbacks00:00:00.000 0.0%34 0.000 0.000 0.000
data read00:00:00.376 0.0%38140 0.000 0.010 0.026
data write00:00:00.841 0.0%29577 0.000 0.028 0.075
idle23:55:18.918100.0%82133 531.403 1048.530 2668.400
status file00:00:04.355 0.0%7925 0.278 0.550 3.143
TOTAL: 23:55:36.21123:55:33.918100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle01:00:18.057 99.8%2809 0.000 1288.023300086.500
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.066 0.0%5888 0.000 0.011 0.500
readart00:00:00.001 0.0%10 0.000 0.100 0.125
TOTAL: 01:00:24.21701:00:18.124 99.8%----

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

Control Channel:

SendernewgrouprmgroupOtherBad PGPDoItOK
control@usenet-fr.news.eu.org001101
TOTAL001101

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1newsfeed.pionier.net.pl 406 841197 841062 0 135 99%111:24:46
2news.icm.edu.pl 46 237 33 179 25 13%15:20:04
3localhost 1452 11 11 0 0 100%00:00:01
TOTAL: 3 1904 841445 841106 179 160 99%126:44:51
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1newsfeed.pionier.net.pl387.2 GB525.7 KB902.5 KB387.2 GB 99%482.7 KB
2news.icm.edu.pl846.4 KB0.0 KB579.0 KB1.4 MB 59%24.6 KB
3localhost16.0 KB0.0 KB0.0 KB16.0 KB100%1.5 KB
TOTAL: 3387.2 GB525.7 KB1.4 MB387.2 GB 99%482.6 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Dec 2 04:15:02 - 04:59:59 19166 2.3% 7.1010.7 GB 2.8%4172.69
Dec 2 05:00:00 - 05:59:59 27761 3.3% 7.7114.3 GB 3.7%4169.55
Dec 2 06:00:00 - 06:59:59 26348 3.1% 7.3213.8 GB 3.6%4005.72
Dec 2 07:00:00 - 07:59:59 26334 3.1% 7.3213.1 GB 3.4%3813.05
Dec 2 08:00:00 - 08:59:59 27298 3.2% 7.5813.4 GB 3.5%3895.49
Dec 2 09:00:00 - 09:59:59 23725 2.8% 6.5912.7 GB 3.3%3700.31
Dec 2 10:00:00 - 10:59:59 29341 3.5% 8.1514.7 GB 3.8%4288.94
Dec 2 11:00:00 - 11:59:59 44197 5.3% 12.2815.8 GB 4.1%4587.69
Dec 2 12:00:00 - 12:59:59 34054 4.0% 9.4616.9 GB 4.4%4935.84
Dec 2 13:00:00 - 13:59:59 31146 3.7% 8.6515.5 GB 4.0%4515.52
Dec 2 14:00:00 - 14:59:59 36722 4.4% 10.2017.4 GB 4.5%5071.54
Dec 2 15:00:00 - 15:59:59 43055 5.1% 11.9618.3 GB 4.7%5325.41
Dec 2 16:00:00 - 16:59:59 45502 5.4% 12.6417.5 GB 4.5%5086.98
Dec 2 17:00:00 - 17:59:59 42917 5.1% 11.9216.7 GB 4.3%4867.51
Dec 2 18:00:00 - 18:59:59 33436 4.0% 9.2916.0 GB 4.1%4650.19
Dec 2 19:00:00 - 19:59:59 38388 4.6% 10.6618.2 GB 4.7%5301.11
Dec 2 20:00:00 - 20:59:59 39518 4.7% 10.9817.8 GB 4.6%5190.20
Dec 2 21:00:00 - 21:59:59 44835 5.3% 12.4517.3 GB 4.5%5037.59
Dec 2 22:00:00 - 22:59:59 43335 5.2% 12.0418.4 GB 4.8%5366.23
Dec 2 23:00:00 - 23:59:59 37943 4.5% 10.5419.7 GB 5.1%5746.35
Dec 3 00:00:00 - 00:59:59 34644 4.1% 9.6216.8 GB 4.3%4881.41
Dec 3 01:00:00 - 01:59:59 39708 4.7% 11.0316.9 GB 4.4%4910.12
Dec 3 02:00:00 - 02:59:59 36875 4.4% 10.2417.4 GB 4.5%5056.59
Dec 3 03:00:00 - 03:59:59 28053 3.3% 7.7914.7 GB 3.8%4272.70
Dec 3 04:00:00 - 04:15:01 6662 0.8% 7.393.4 GB 0.9%3929.76
TOTAL: 23:59:59 840963 100.0% 9.73387.2 GB 100.0%4699.50
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1newsfeed.pionier.net.pl 465 124 0 6 5 0 0 0 330
2news.icm.edu.pl 25 0 0 0 0 0 0 0 25
TOTAL: 2 490 124 0 6 5 0 0 0 355

Unwanted newsgroups [Top 20]:

NewsgroupCount
uk.railway 74
it.comp.os.win.windows10 17
comp.mobile.android 8
alt.comp.software.firefox 7
it.tlc.cellulari.android 5
alt.comp.software.seamonkey 5
comp.sys.raspberry-pi 5
it.discussioni.energia 1
nl.comp.os.linux.techniek 1
de.rec.sf.startrek 1
TOTAL: 10 124

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

GroupsCount
pl.praca.oferowana 5
TOTAL: 1 5

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 25
TOTAL: 1 25

Miscellaneous innd statistics [Top 10]:

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

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1icm 17204 292 8640 36 0 0 1%23:59:56
2panorama 20812 143 7513 127 65 21774 0%23:59:26
3nask 0 0 0 0 0 6244 0%23:57:47
4poznan 33 0 30 0 0 0 0%02:22:50
5okapi 0 0 0 0 0 887 0%23:57:47
TOTAL: 5 38049 435 16183 163 65 28905 1%98:17:46
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1icm3.1 MB812.6 KB3.9 MB0.0 KB/s12.2 KB23:59:56
2panorama397.4 KB1.6 MB2.0 MB0.0 KB/s7.5 KB23:59:26
3nask0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:47
4poznan0.0 KB0.0 KB0.0 KB0.0 KB/s002:22:50
5okapi0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:47
TOTAL: 53.5 MB2.4 MB5.9 MB0.0 KB/s10.1 KB98:17:46
Outgoing feeds (innfeed) by Volume

Backlog files shrunk by innfeed:

ServerSize
panorama488.4 KB
TOTAL: 1488.4 KB

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1web.man.lodz.pl 294 107.9 KB 2 0 000:00:09
2isvcs01.man.lodz.pl 11 00.0 KB 0 11 000:00:00
TOTAL: 2 305 107.9 KB 2 11 001:00:24

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.man.lodz.pl 307 107.9 KB 2 11 001:00:10
2*.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:10
3unresolved 100 00.0 KB 0 0 000:00:03
TOTAL: 3 408 107.9 KB 2 11 001:00:24

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
pc-tom.man.lodz.pl 0.016 0.000 0.00001:00:01
fantastic.monitoring.internet-measurement.com 0.005 0.003 0.00000:00:10
web.man.lodz.pl 0.791 1.794 0.00000:00:09
80.111.142.213 0.010 0.033 0.00000:00:02
212.51.192.185 0.240 0.563 0.00000:00:01
isvcs01.man.lodz.pl 0.063 0.073 0.00000:00:00
TOTAL: 6 1.125 2.466 0.00001:00:24

Curious NNRP server explorers [Top 20]:

SystemConn
212.51.192.185 96
80.111.142.213 4
pc-tom.man.lodz.pl 2
fantastic.monitoring.internet-measurement.com 1
TOTAL: 4 103

NNRP client timeouts [Top 20]:

SystemConnPeer
pc-tom.man.lodz.pl 2 0
TOTAL: 1 2 0

Newsgroup request counts (by category):

CategoryCountPct
1pl 10100.0%
TOTAL: 1 10100.0%

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

NewsgroupCount
1pl.comp.pecet 10
TOTAL: 1 10