Daily Usenet Report

Nov 23 00:01:02 -- Nov 24 00:01:01

Unknown entries from news log file:

First 3 / 3 lines (100.0%)

Nov 23 00:06:06 www innd: message repeated 2 times: [ ctlinnd command s]
Nov 23 20:45:43 www nnrpd[300195]: unable to get certificates from '/news/etc/cert.pem'
Nov 23 20:45:43 www nnrpd[300195]: 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 13855 67.9%3.7 MB 78.8%
innd 4094 20.1%573.5 KB 12.0%
innfeed 2324 11.4%433.0 KB 9.0%
nnrpd 128 0.6%10.2 KB 0.2%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 5 20402 100.0%4.7 MB100.0%

History cache:

ReasonCount%Count
Positive hits 95409 56.2%
Negative hits 60914 35.9%
Do not exist 13516 8.0%
Cache misses 34 0.0%
TOTAL: 4 169873 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.103 0.0%63 0.000 1.635 5.000
article cleanup00:00:00.276 0.0%13538 0.000 0.020 0.118
article logging00:00:00.651 0.0%13781 0.000 0.047 0.138
article parse00:00:00.543 0.0%27029 0.000 0.020 0.063
article write00:00:11.277 0.0%11618 0.449 0.971 1.837
artlog/artcncl00:00:00.000 0.0%63 0.000 0.000 0.000
data move00:00:00.204 0.0%179099 0.000 0.001 0.008
hisgrep/artcncl00:00:00.012 0.0%62 0.000 0.194 1.000
hishave/artcncl00:00:00.012 0.0%63 0.000 0.190 1.500
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:06.798 0.0%170072 0.003 0.040 0.075
history sync00:00:00.052 0.0%393 0.000 0.132 1.000
history write00:00:07.589 0.0%13536 0.118 0.561 0.981
hiswrite/artcncl00:00:00.001 0.0%1 1.000 1.000 1.000
idle23:58:18.239 99.8%176055 122.215 490.178 1781.448
nntp read00:00:08.938 0.0%176890 0.030 0.051 0.118
overview write00:00:07.263 0.0%11618 0.250 0.625 4.093
perl filter00:00:38.660 0.0%13536 2.154 2.856 5.231
python filter00:00:02.219 0.0%13536 0.070 0.164 0.435
site send00:00:04.610 0.0%23236 0.071 0.198 0.453
TOTAL: 24:01:06.40423:59:47.447 99.9%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.100 0.0%11693 0.000 0.009 0.193
article prepare00:00:00.005 0.0%34488 0.000 0.000 0.006
article read00:00:01.513 0.0%5425 0.053 0.279 2.000
backlog stats00:00:00.459 0.0%233574 0.000 0.002 0.016
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:05.994 0.0%160597 0.014 0.037 0.075
data write00:00:22.704 0.0%150547 0.106 0.151 0.265
idle23:55:08.856100.0%233574 203.666 368.658 1028.675
status file00:00:00.200 0.0%189 0.000 1.058 3.000
TOTAL: 23:55:50.76223:55:39.831100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:01.791 70.4%7 22.333 255.857 1642.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.000 0.0%14 0.000 0.000 0.000
TOTAL: 00:00:02.54300:00:01.791 70.4%----

Control commands to INND:

CommandNumber
flush 4
flushlogs 2
go 2
logmode 2
lowmark 1
mode 146
name 2
pause 2
paused 2
reload 2
reserve 2
TOTAL: 11 167

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1endofthelinebbs-out.news.weretis.net 5 23367 6906 16120 341 29%54:37:45
2usenet.blueworldhosting.com 6 12760 3693 8648 419 28%24:44:52
3outgoing.news.lysator.liu.se 2 13050 680 11596 774 5%23:59:19
4newsfeed.xs3.de 2 10401 408 9990 3 3%23:59:53
5news.samoylyk.net 2 10496 53 10443 0 0%23:59:43
6glockenspiel.complete.org 2 10127 19 10108 0 0%24:02:55
7news.furie.org.uk 1 6115 7 6108 0 0%23:59:50
8news.bbs.nz 2 12727 7 12720 0 0%29:40:07
9news.netfront.net 1 15834 4 15285 545 0%28:21:13
10localhost 25 0 0 0 0 0%00:00:00
11news.nk.ca 2 0 0 0 0 0%00:20:00
12eotl-out.news.tnetconsulting.net 1 0 0 0 0 0%00:10:03
TOTAL: 12 51 114877 11777 101018 2082 10%257:55:40
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1endofthelinebbs-out.news.weretis.net23.3 MB25.0 KB649.8 KB24.0 MB 97%3.4 KB
2usenet.blueworldhosting.com21.3 MB24.9 KB1.2 MB22.5 MB 94%5.6 KB
3newsfeed.xs3.de1.6 MB0.0 KB3.9 KB1.6 MB 99%4.0 KB
4outgoing.news.lysator.liu.se1.4 MB0.0 KB2.4 MB3.8 MB 36%2.7 KB
5news.samoylyk.net434.6 KB0.0 KB0.0 KB434.6 KB100%8.2 KB
6glockenspiel.complete.org65.5 KB0.0 KB0.0 KB65.5 KB100%3.4 KB
7news.furie.org.uk29.7 KB0.0 KB0.0 KB29.7 KB100%4.2 KB
8news.netfront.net10.2 KB0.0 KB64.6 MB64.6 MB 0%120.6 KB
9news.bbs.nz8.2 KB0.0 KB0.0 KB8.2 KB100%1.2 KB
10localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
11news.nk.ca0.0 KB0.0 KB0.0 KB0.0 KB 0%0
12eotl-out.news.tnetconsulting.net0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 1248.1 MB49.9 KB68.9 MB117.1 MB 41%8.6 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Nov 23 00:01:02 - 00:59:59 289 2.5% 0.08985.2 KB 2.1% 0.28
Nov 23 01:00:00 - 01:59:59 314 2.7% 0.091.2 MB 2.5% 0.34
Nov 23 02:00:00 - 02:59:59 534 4.6% 0.151.6 MB 3.5% 0.47
Nov 23 03:00:00 - 03:59:59 513 4.4% 0.142.0 MB 4.3% 0.57
Nov 23 04:00:00 - 04:59:59 612 5.3% 0.171.9 MB 4.0% 0.53
Nov 23 05:00:00 - 05:59:59 698 6.0% 0.191.9 MB 4.2% 0.55
Nov 23 06:00:00 - 06:59:59 545 4.7% 0.151.6 MB 3.5% 0.47
Nov 23 07:00:00 - 07:59:59 552 4.8% 0.151.8 MB 3.9% 0.51
Nov 23 08:00:00 - 08:59:59 571 4.9% 0.162.7 MB 5.7% 0.76
Nov 23 09:00:00 - 09:59:59 723 6.2% 0.202.8 MB 6.0% 0.79
Nov 23 10:00:00 - 10:59:59 726 6.2% 0.204.2 MB 9.1% 1.20
Nov 23 11:00:00 - 11:59:59 733 6.3% 0.203.6 MB 7.7% 1.01
Nov 23 12:00:00 - 12:59:59 627 5.4% 0.172.1 MB 4.5% 0.60
Nov 23 13:00:00 - 13:59:59 556 4.8% 0.152.0 MB 4.3% 0.56
Nov 23 14:00:00 - 14:59:59 611 5.3% 0.172.0 MB 4.4% 0.58
Nov 23 15:00:00 - 15:59:59 554 4.8% 0.151.9 MB 4.2% 0.55
Nov 23 16:00:00 - 16:59:59 541 4.7% 0.152.5 MB 5.4% 0.71
Nov 23 17:00:00 - 17:59:59 389 3.3% 0.112.2 MB 4.8% 0.63
Nov 23 18:00:00 - 18:59:59 347 3.0% 0.101.1 MB 2.5% 0.32
Nov 23 19:00:00 - 19:59:59 245 2.1% 0.071.2 MB 2.6% 0.34
Nov 23 20:00:00 - 20:59:59 278 2.4% 0.081004.7 KB 2.1% 0.28
Nov 23 21:00:00 - 21:59:59 237 2.0% 0.071.8 MB 3.9% 0.52
Nov 23 22:00:00 - 22:59:59 199 1.7% 0.06966.2 KB 2.0% 0.27
Nov 23 23:00:00 - 23:59:59 214 1.8% 0.061.2 MB 2.6% 0.34
Nov 24 00:00:00 - 00:01:01 9 0.1% 0.1520.5 KB 0.0% 0.34
TOTAL: 23:59:59 11617 100.0% 0.1346.3 MB 100.0% 0.55
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1outgoing.news.lysator.liu.se 761 0 0 0 0 0 0 0 761
2endofthelinebbs-out.news.weretis.net 557 0 0 1 0 0 0 0 556
3news.netfront.net 434 0 0 0 0 0 0 0 434
4usenet.blueworldhosting.com 407 9 0 1 0 0 0 0 397
5newsfeed.xs3.de 14 0 0 0 0 0 0 0 14
6news.samoylyk.net 2 0 0 0 0 0 0 0 2
TOTAL: 6 2175 9 0 2 0 0 0 0 2164

Unwanted newsgroups [Top 20]:

NewsgroupCount
rocksolid.feeds.news 5
rocksolid.feeds.tech 2
bipolartriste10gmail.com 1
alt.radio.free 1
TOTAL: 4 9

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 816
EMP (phn path) 631
Binary: misplaced binary 152
EMP (phl) 129
EMP (phn nph) 107
Too many newsgroups 41
Poison newsgroup 23
Scoring filter 13
HTML Multipart 5
Too many newsgroups (meow) 4
TOTAL: 10 1921

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
endofthelinebbs-out.news.weretis.net 216
newsfeed.xs3.de 11
usenet.blueworldhosting.com 9
outgoing.news.lysator.liu.se 5
news.samoylyk.net 2
TOTAL: 5 243
TOTAL: 1 243

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.netfront.net 14692 5162 6447 6 0 1 35%23:59:55
2nyheter.lysator.liu.se 11479 2952 7978 10 0 0 25%23:59:55
3news.nk.ca 15056 84 11464 33 0 6 0%23:59:55
4news.furie.org.uk 8277 68 6360 6 0 0 0%23:59:55
5news.quux.org 12039 62 11384 139 0 0 0%23:59:48
6news.bbs.nz 22735 32 11527 53 0 87 0%23:59:55
7news.tnetconsulting.net 12401 18 11594 4 0 0 0%23:59:53
8news.weretis.net 11650 3 11611 0 0 0 0%23:59:36
9usenet.blueworldhosting.com 8179 3 7899 0 0 0 0%23:59:55
10news.samoylyk.net 13705 0 11567 0 0 0 0%23:59:55
11peer.alt119.net 0 0 0 0 0 11605 0%23:57:47
12newsfeed.xs3.de 12583 0 11202 0 0 0 0%23:59:55
TOTAL: 12 142796 8384 109033 251 0 11699 5%287:56:24
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.netfront.net24.2 MB18.9 KB24.3 MB0.3 KB/s4.8 KB23:59:55
2nyheter.lysator.liu.se17.0 MB64.9 KB17.0 MB0.2 KB/s5.9 KB23:59:55
3news.furie.org.uk4.4 MB72.1 KB4.4 MB0.1 KB/s61.4 KB23:59:55
4news.nk.ca1.2 MB154.7 KB1.3 MB0.0 KB/s11.4 KB23:59:55
5news.bbs.nz863.6 KB422.6 KB1.3 MB0.0 KB/s15.1 KB23:59:55
6news.quux.org613.5 KB1009.9 KB1.6 MB0.0 KB/s8.1 KB23:59:48
7news.tnetconsulting.net82.9 KB21.4 KB104.3 KB0.0 KB/s4.7 KB23:59:53
8news.weretis.net7.7 KB0.0 KB7.7 KB0.0 KB/s2.6 KB23:59:36
9usenet.blueworldhosting.com6.8 KB0.0 KB6.8 KB0.0 KB/s2.3 KB23:59:55
10news.samoylyk.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:55
11peer.alt119.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:57:47
12newsfeed.xs3.de0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:55
TOTAL: 1248.3 MB1.7 MB50.0 MB0.0 KB/s5.9 KB287:56:24
Outgoing feeds (innfeed) by Volume

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1unresolved 1 00.0 KB 3 0 000:00:00
2*.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:01
3*.ch1.censys-scanner.com 2 00.0 KB 0 0 000:00:00
TOTAL: 3 4 00.0 KB 3 0 000:00:02

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
elite.monitoring.internet-measurement.com 0.094 0.021 0.00000:00:01
scanner-06.ch1.censys-scanner.com 0.167 0.076 0.00000:00:00
192.241.203.219 0.076 0.065 0.00000:00:00
TOTAL: 3 0.337 0.162 0.00000:00:02

Curious NNRP server explorers [Top 20]:

SystemConn
scanner-06.ch1.censys-scanner.com 2
192.241.203.219 1
elite.monitoring.internet-measurement.com 1
TOTAL: 3 4

NNRP unrecognized commands (by host):

SystemConn
scanner-06.ch1.censys-scanner.com 1
192.241.203.219 1
TOTAL: 2 2

NNRP unrecognized commands (by command):

CommandCount
MGLNDD_192.138.210.162_119 1
EHLO www.censys.io 1
TOTAL: 2 2

Newsgroup request counts (by category):

CategoryCountPct
1soc 4100.0%
TOTAL: 1 4100.0%

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

NewsgroupCount
1soc.genealogy.britain 3
2soc.genealogy.misc 1
TOTAL: 2 4