Daily Usenet Report

Sep 13 00:01:02 -- Sep 14 00:01:01

Unknown entries from news log file:

First 3 / 3 lines (100.0%)

Sep 13 00:04:47 www innd: message repeated 2 times: [ ctlinnd command s]
Sep 13 23:39:54 www nnrpd[778966]: unable to get certificates from '/news/etc/cert.pem'
Sep 13 23:39:54 www nnrpd[778966]: error initializing TLS: [CA_file: ] [CA_path: /news/etc] [cert_file: /news/etc/cert.pem] [key_file: /news/etc/key.pem]

Log entries by program:

Program nameLines%LinesSize%Size
inn 13751 69.7%3.0 MB 76.8%
innd 3762 19.1%535.2 KB 13.2%
innfeed 2189 11.1%397.7 KB 9.8%
nnrpd 19 0.1%1.9 KB 0.0%
controlchan 17 0.1%3.5 KB 0.1%
TOTAL: 5 19738 100.0%4.0 MB100.0%

History cache:

ReasonCount%Count
Positive hits 84108 55.2%
Negative hits 54667 35.9%
Do not exist 13356 8.8%
Cache misses 143 0.1%
TOTAL: 4 152274 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.076 0.0%53 0.000 1.434 4.000
article cleanup00:00:00.248 0.0%13473 0.000 0.018 0.078
article logging00:00:00.654 0.0%13692 0.000 0.048 0.133
article parse00:00:00.441 0.0%21371 0.000 0.021 0.074
article write00:00:09.552 0.0%11634 0.409 0.821 2.758
artlog/artcncl00:00:00.001 0.0%53 0.000 0.019 0.100
artlog/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
data move00:00:00.202 0.0%158665 0.000 0.001 0.007
hisgrep/artcncl00:00:00.016 0.0%52 0.000 0.308 1.500
hishave/artcncl00:00:00.004 0.0%53 0.000 0.075 0.400
hishave/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:06.026 0.0%153675 0.005 0.039 0.093
history sync00:00:00.057 0.0%387 0.000 0.147 1.000
history write00:00:06.431 0.0%13472 0.078 0.477 1.022
hiswrite/artcncl00:00:00.000 0.0%1 0.000 0.000 0.000
hiswrite/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
idle23:58:34.919 99.8%155094 294.848 556.533 1847.711
nntp read00:00:07.696 0.0%156850 0.028 0.049 0.084
overview write00:00:07.403 0.0%11634 0.231 0.636 4.788
perl filter00:00:34.227 0.0%13472 1.880 2.541 5.256
python filter00:00:02.017 0.0%13472 0.035 0.150 0.349
site send00:00:04.073 0.0%23271 0.035 0.175 0.478
TOTAL: 24:01:02.08723:59:54.043 99.9%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.141 0.0%12541 0.000 0.011 0.149
article prepare00:00:00.001 0.0%14052 0.000 0.000 0.014
article read00:00:00.714 0.0%1951 0.000 0.366 14.500
backlog stats00:00:00.439 0.0%222010 0.000 0.002 0.014
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:05.733 0.0%143367 0.016 0.040 0.061
data write00:00:18.947 0.0%132373 0.101 0.143 0.291
idle23:46:33.008100.0%222010 203.641 385.537 1070.631
status file00:00:00.180 0.0%172 0.000 1.047 5.000
TOTAL: 23:47:08.85523:46:59.163100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:30:00.381100.0%7 24.500257197.286900072.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.003 0.0%19 0.000 0.158 0.222
TOTAL: 00:30:00.78600:30:00.384100.0%----

Control commands to INND:

CommandNumber
flush 4
flushlogs 2
go 3
logmode 2
lowmark 1
mode 146
name 2
pause 3
paused 3
reload 4
reserve 2
rmgroup 2
TOTAL: 12 174

Newsgroups removed:

Group
fr.soc.histoire.medievale
fr.soc.histoire.moderne-1453-1789
TOTAL: 2

Control Channel:

SendernewgrouprmgroupOtherBad PGPDoItOK
control@usenet-fr.news.eu.org021033
TOTAL021033

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1peer.alt119.net 3 13372 4512 8430 430 33%26:33:15
2usenet.blueworldhosting.com 4 12962 3845 8245 872 29%24:13:07
3endofthelinebbs-out.news.weretis.net 7 23662 1748 21473 441 7%49:58:51
4newsfeed.xs3.de 3 10764 1514 9146 104 14%23:59:47
5news.bbs.nz 3 11058 45 11013 0 0%23:24:51
6news.samoylyk.net 2 10955 39 10915 1 0%23:59:47
7glockenspiel.complete.org 2 11040 21 11019 0 0%23:59:44
8news.furie.org.uk 2 6219 13 6206 0 0%23:59:40
9eotl-out.news.tnetconsulting.net 1 0 0 0 0 0%00:10:04
10news.nk.ca 2 0 0 0 0 0%00:20:01
11localhost 25 0 0 0 0 0%00:00:00
TOTAL: 11 54 100032 11737 86447 1848 11%220:39:07
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1usenet.blueworldhosting.com26.7 MB0.0 KB2.1 MB28.8 MB 92%6.2 KB
2peer.alt119.net11.2 MB0.0 KB1.5 MB12.7 MB 88%2.6 KB
3endofthelinebbs-out.news.weretis.net6.7 MB2.0 KB963.0 KB7.6 MB 87%3.6 KB
4newsfeed.xs3.de4.2 MB0.0 KB224.0 KB4.4 MB 95%2.8 KB
5glockenspiel.complete.org296.1 KB0.0 KB0.0 KB296.1 KB100%14.1 KB
6news.samoylyk.net177.2 KB0.0 KB3.7 KB180.8 KB 97%4.5 KB
7news.bbs.nz89.9 KB0.0 KB0.0 KB89.9 KB100%2.0 KB
8news.furie.org.uk81.7 KB0.0 KB0.0 KB81.7 KB100%6.3 KB
9eotl-out.news.tnetconsulting.net0.0 KB0.0 KB0.0 KB0.0 KB 0%0
10news.nk.ca0.0 KB0.0 KB0.0 KB0.0 KB 0%0
11localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 1149.4 MB2.0 KB4.8 MB54.2 MB 91%4.1 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Sep 13 00:01:02 - 00:59:59 303 2.6% 0.091.9 MB 3.8% 0.54
Sep 13 01:00:00 - 01:59:59 403 3.5% 0.111.8 MB 3.7% 0.52
Sep 13 02:00:00 - 02:59:59 436 3.7% 0.121.5 MB 3.1% 0.43
Sep 13 03:00:00 - 03:59:59 568 4.9% 0.161.8 MB 3.7% 0.52
Sep 13 04:00:00 - 04:59:59 582 5.0% 0.163.1 MB 6.2% 0.87
Sep 13 05:00:00 - 05:59:59 614 5.3% 0.172.0 MB 4.1% 0.58
Sep 13 06:00:00 - 06:59:59 440 3.8% 0.121.5 MB 3.0% 0.42
Sep 13 07:00:00 - 07:59:59 584 5.0% 0.162.8 MB 5.7% 0.80
Sep 13 08:00:00 - 08:59:59 651 5.6% 0.182.1 MB 4.4% 0.61
Sep 13 09:00:00 - 09:59:59 711 6.1% 0.203.3 MB 6.7% 0.94
Sep 13 10:00:00 - 10:59:59 813 7.0% 0.234.5 MB 9.1% 1.27
Sep 13 11:00:00 - 11:59:59 623 5.4% 0.172.4 MB 4.9% 0.69
Sep 13 12:00:00 - 12:59:59 621 5.3% 0.171.9 MB 3.8% 0.53
Sep 13 13:00:00 - 13:59:59 701 6.0% 0.192.3 MB 4.6% 0.64
Sep 13 14:00:00 - 14:59:59 601 5.2% 0.172.0 MB 4.0% 0.56
Sep 13 15:00:00 - 15:59:59 574 4.9% 0.162.0 MB 4.1% 0.57
Sep 13 16:00:00 - 16:59:59 484 4.2% 0.133.1 MB 6.2% 0.87
Sep 13 17:00:00 - 17:59:59 381 3.3% 0.111.3 MB 2.6% 0.37
Sep 13 18:00:00 - 18:59:59 274 2.4% 0.081.1 MB 2.1% 0.30
Sep 13 19:00:00 - 19:59:59 296 2.5% 0.081.3 MB 2.7% 0.37
Sep 13 20:00:00 - 20:59:59 280 2.4% 0.082.5 MB 5.1% 0.71
Sep 13 21:00:00 - 21:59:59 239 2.1% 0.071.4 MB 2.9% 0.41
Sep 13 22:00:00 - 22:59:59 219 1.9% 0.06805.6 KB 1.6% 0.22
Sep 13 23:00:00 - 23:59:59 238 2.0% 0.07908.6 KB 1.8% 0.25
Sep 14 00:00:00 - 00:01:01 4 0.0% 0.0715.4 KB 0.0% 0.25
TOTAL: 23:59:59 11640 100.0% 0.1349.2 MB 100.0% 0.58
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1usenet.blueworldhosting.com 884 140 0 0 0 0 0 0 744
2endofthelinebbs-out.news.weretis.net 506 0 0 1 0 0 0 0 505
3peer.alt119.net 478 8 0 0 0 0 0 0 470
4newsfeed.xs3.de 186 0 0 0 0 0 0 0 186
5news.samoylyk.net 4 0 0 0 0 0 0 0 4
TOTAL: 5 2058 148 0 1 0 0 0 0 1909

Unwanted newsgroups [Top 20]:

NewsgroupCount
talk.english.tg 55
talk.generic.ua.ws 17
att.jobs 12
at.jobs 11
talk.from.war.diary 8
panix.chat 8
talk.english.tw 8
rocksolid.feeds.news 5
talk.from.diary 5
aus.jobs 5
news.oriens-occasus.ru 4
alt.jobs.search.tw 3
grisbi.bugsreports 3
grisbi.test 1
ee.arvutid 1
fr.petites-annonces.informatique.materiel 1
panix.test 1
TOTAL: 17 148

INND Perl filter [Top 20]:

ReasonCount
EMP (phn path) 840
EMP (md5) 444
EMP (phl) 156
EMP (phn nph) 119
Too many newsgroups 118
Scoring filter 8
HTML Multipart 2
Too many newsgroups (meow) 1
MID-Bot 1
TOTAL: 9 1689

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
newsfeed.xs3.de 79
endofthelinebbs-out.news.weretis.net 70
peer.alt119.net 55
usenet.blueworldhosting.com 13
news.samoylyk.net 3
TOTAL: 5 220
TOTAL: 1 220

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1peer.alt119.net 9298 1388 5837 9 0 1 14%23:59:44
2news.bbs.nz 20625 1227 10227 169 0 967 5%23:59:44
3news.nk.ca 16388 346 11139 82 0 10 2%23:59:45
4news.quux.org 13316 134 11359 117 0 0 1%23:59:45
5news.furie.org.uk 9845 35 6448 15 0 18 0%23:59:44
6usenet.blueworldhosting.com 8236 3 7793 1 0 2 0%23:59:45
7news.tnetconsulting.net 13037 1 11628 4 0 2 0%23:59:45
8news.weretis.net 11784 0 11632 1 0 2 0%23:59:42
9newsfeed.xs3.de 13506 0 10046 6 0 5 0%23:59:44
10news.samoylyk.net 15060 0 11596 5 0 4 0%23:59:44
TOTAL: 10 131095 3134 97705 409 0 1011 2%239:57:22
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1peer.alt119.net11.0 MB33.7 KB11.0 MB0.1 KB/s8.1 KB23:59:44
2news.bbs.nz8.1 MB928.9 KB9.0 MB0.1 KB/s6.6 KB23:59:44
3news.nk.ca4.9 MB526.9 KB5.4 MB0.1 KB/s12.9 KB23:59:45
4news.quux.org3.4 MB535.0 KB3.9 MB0.0 KB/s16.0 KB23:59:45
5news.furie.org.uk175.4 KB125.4 KB300.8 KB0.0 KB/s6.0 KB23:59:44
6usenet.blueworldhosting.com7.6 KB22.1 KB29.6 KB0.0 KB/s7.4 KB23:59:45
7news.tnetconsulting.net2.3 KB6.1 KB8.4 KB0.0 KB/s1.7 KB23:59:45
8news.weretis.net0.0 KB5.2 KB5.2 KB0.0 KB/s5.2 KB23:59:42
9newsfeed.xs3.de0.0 KB19.9 KB19.9 KB0.0 KB/s3.3 KB23:59:44
10news.samoylyk.net0.0 KB13.4 KB13.4 KB0.0 KB/s2.7 KB23:59:44
TOTAL: 1027.6 MB2.2 MB29.7 MB0.0 KB/s8.6 KB239:57:22
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1192.241.203.140 1 00.0 KB 0 0 000:00:00
2scanner-07.ch1.censys-scanner.com 1 00.0 KB 0 0 000:00:00
3123.160.221.40 1 00.0 KB 0 0 000:30:00
TOTAL: 3 3 00.0 KB 0 0 000:30:00

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1unresolved 2 00.0 KB 0 0 000:30:00
2*.ch1.censys-scanner.com 1 00.0 KB 0 0 000:00:00
TOTAL: 2 3 00.0 KB 0 0 000:30:00

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
123.160.221.40 0.062 0.055 0.00000:30:00
scanner-07.ch1.censys-scanner.com 0.092 0.033 0.00000:00:00
192.241.203.140 0.085 0.052 0.00000:00:00
TOTAL: 3 0.239 0.140 0.00000:30:00

NNRP unrecognized commands (by host):

SystemConn
123.160.221.40 3
192.241.203.140 1
scanner-07.ch1.censys-scanner.com 1
TOTAL: 3 5

NNRP unrecognized commands (by command):

CommandCount
#023#001#023#002#023#003#001 1
À#024 1
EHLO www.censys.io 1
MGLNDD_192.138.210.162_119 1
#026#003#001 1
TOTAL: 5 5

NNRP client timeouts [Top 20]:

SystemConnPeer
123.160.221.40 1 0
TOTAL: 1 1 0