Daily Usenet Report

Aug 7 00:01:01 -- Aug 8 00:01:02

Unknown entries from news log file:

First 3 / 3 lines (100.0%)

Aug 7 00:03:51 www innd: message repeated 2 times: [ ctlinnd command s]
Aug 7 22:19:51 www nnrpd[1770516]: unable to get certificates from '/news/etc/cert.pem'
Aug 7 22:19:51 www nnrpd[1770516]: 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 12619 67.8%2.8 MB 75.6%
innd 3995 21.5%560.1 KB 14.6%
innfeed 1974 10.6%372.4 KB 9.7%
nnrpd 25 0.1%2.7 KB 0.1%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 5 18614 100.0%3.7 MB100.0%

History cache:

ReasonCount%Count
Positive hits 72933 54.2%
Negative hits 49367 36.7%
Do not exist 12185 9.1%
Cache misses 27 0.0%
TOTAL: 4 134512 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.118 0.0%101 0.000 1.168 8.000
article cleanup00:00:00.288 0.0%12213 0.000 0.024 0.097
article logging00:00:00.486 0.0%12525 0.000 0.039 0.103
article parse00:00:00.408 0.0%18186 0.000 0.022 0.147
article write00:00:07.392 0.0%10139 0.400 0.729 3.099
artlog/artcncl00:00:00.000 0.0%101 0.000 0.000 0.000
artlog/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
data move00:00:00.168 0.0%140183 0.000 0.001 0.008
hisgrep/artcncl00:00:00.013 0.0%98 0.000 0.133 1.000
hishave/artcncl00:00:00.003 0.0%101 0.000 0.030 1.000
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:04.622 0.0%134764 0.001 0.034 0.083
history sync00:00:00.068 0.0%408 0.000 0.167 0.667
history write00:00:05.424 0.0%12211 0.095 0.444 0.884
hiswrite/artcncl00:00:00.001 0.0%3 0.000 0.333 1.000
hiswrite/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
idle23:58:59.687 99.9%137492 367.495 627.962 1862.634
nntp read00:00:04.804 0.0%138681 0.014 0.035 0.066
overview write00:00:07.266 0.0%10139 0.185 0.717 2.891
perl filter00:00:35.131 0.0%12211 2.164 2.877 5.595
python filter00:00:02.111 0.0%12211 0.050 0.173 0.475
site send00:00:04.191 0.0%20278 0.044 0.207 0.675
TOTAL: 24:01:08.85124:00:12.181 99.9%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.118 0.0%10160 0.000 0.012 0.164
article prepare00:00:00.002 0.0%10148 0.000 0.000 0.017
article read00:00:00.561 0.0%1610 0.000 0.348 11.250
backlog stats00:00:00.369 0.0%185423 0.000 0.002 0.006
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:03.634 0.0%126579 0.012 0.029 0.054
data write00:00:16.030 0.0%116756 0.073 0.137 0.232
idle23:56:48.161100.0%185423 259.477 464.927 1339.523
status file00:00:00.183 0.0%168 0.000 1.089 8.000
TOTAL: 23:57:16.26123:57:09.058100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:01.265 38.9%11 24.500 115.000 221.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.001 0.0%26 0.000 0.038 0.200
TOTAL: 00:00:03.25600:00:01.266 38.9%----

Control commands to INND:

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

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1endofthelinebbs-out.news.weretis.net 4 22596 4848 17528 220 21%58:58:42
2usenet.blueworldhosting.com 5 11560 3157 7395 1008 27%24:52:01
3peer.alt119.net 3 11685 2130 8728 827 18%24:08:40
4newsfeed.xs3.de 1 9247 223 9022 2 2%23:59:54
5glockenspiel.complete.org 2 9701 32 9666 3 0%23:59:23
6news.samoylyk.net 2 9417 24 9392 1 0%23:59:45
7news.furie.org.uk 1 5291 17 5274 0 0%23:59:49
8news.bbs.nz 2 9711 17 9694 0 0%23:59:24
9localhost 25 0 0 0 0 0%00:00:00
10eotl-out.news.tnetconsulting.net 1 0 0 0 0 0%00:10:04
11news.nk.ca 3 0 0 0 0 0%00:20:02
TOTAL: 11 49 89208 10448 76699 2061 11%228:27:44
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1usenet.blueworldhosting.com18.6 MB0.0 KB2.4 MB21.0 MB 88%5.2 KB
2endofthelinebbs-out.news.weretis.net15.3 MB1.3 KB457.5 KB15.8 MB 97%3.2 KB
3peer.alt119.net4.8 MB1.2 KB2.9 MB7.7 MB 62%2.6 KB
4newsfeed.xs3.de744.7 KB0.0 KB3.0 KB747.7 KB 99%3.3 KB
5glockenspiel.complete.org189.6 KB0.0 KB7.5 KB197.0 KB 96%5.6 KB
6news.samoylyk.net148.3 KB0.0 KB1.2 KB149.5 KB 99%6.0 KB
7news.furie.org.uk63.4 KB0.0 KB0.0 KB63.4 KB100%3.7 KB
8news.bbs.nz50.6 KB0.0 KB0.0 KB50.6 KB100%3.0 KB
9localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
10eotl-out.news.tnetconsulting.net0.0 KB0.0 KB0.0 KB0.0 KB 0%0
11news.nk.ca0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 1139.8 MB2.5 KB5.8 MB45.6 MB 87%3.7 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Aug 7 00:01:01 - 00:59:59 226 2.2% 0.06666.1 KB 1.7% 0.19
Aug 7 01:00:00 - 01:59:59 324 3.2% 0.091.3 MB 3.3% 0.36
Aug 7 02:00:00 - 02:59:59 366 3.6% 0.101.9 MB 4.9% 0.53
Aug 7 03:00:00 - 03:59:59 483 4.8% 0.131.3 MB 3.5% 0.38
Aug 7 04:00:00 - 04:59:59 587 5.8% 0.161.6 MB 4.0% 0.44
Aug 7 05:00:00 - 05:59:59 580 5.7% 0.161.7 MB 4.5% 0.50
Aug 7 06:00:00 - 06:59:59 492 4.9% 0.141.2 MB 3.2% 0.35
Aug 7 07:00:00 - 07:59:59 474 4.7% 0.131.3 MB 3.3% 0.36
Aug 7 08:00:00 - 08:59:59 526 5.2% 0.152.3 MB 5.9% 0.64
Aug 7 09:00:00 - 09:59:59 547 5.4% 0.151.6 MB 4.1% 0.45
Aug 7 10:00:00 - 10:59:59 539 5.3% 0.152.1 MB 5.5% 0.60
Aug 7 11:00:00 - 11:59:59 489 4.8% 0.141.6 MB 4.1% 0.44
Aug 7 12:00:00 - 12:59:59 523 5.2% 0.152.5 MB 6.5% 0.71
Aug 7 13:00:00 - 13:59:59 543 5.4% 0.152.1 MB 5.5% 0.59
Aug 7 14:00:00 - 14:59:59 532 5.3% 0.151.8 MB 4.7% 0.51
Aug 7 15:00:00 - 15:59:59 556 5.5% 0.152.0 MB 5.2% 0.56
Aug 7 16:00:00 - 16:59:59 492 4.9% 0.142.9 MB 7.5% 0.82
Aug 7 17:00:00 - 17:59:59 439 4.3% 0.122.3 MB 5.9% 0.65
Aug 7 18:00:00 - 18:59:59 332 3.3% 0.091.8 MB 4.7% 0.52
Aug 7 19:00:00 - 19:59:59 214 2.1% 0.06814.4 KB 2.1% 0.23
Aug 7 20:00:00 - 20:59:59 216 2.1% 0.061.5 MB 4.0% 0.44
Aug 7 21:00:00 - 21:59:59 231 2.3% 0.06769.8 KB 2.0% 0.21
Aug 7 22:00:00 - 22:59:59 186 1.8% 0.05709.7 KB 1.8% 0.20
Aug 7 23:00:00 - 23:59:59 229 2.3% 0.06746.6 KB 1.9% 0.21
Aug 8 00:00:00 - 00:01:02 6 0.1% 0.1071.0 KB 0.2% 1.15
TOTAL: 24:00:01 10132 100.0% 0.1238.3 MB 100.0% 0.45
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1usenet.blueworldhosting.com 1072 84 0 0 0 0 0 0 988
2peer.alt119.net 835 0 0 1 0 0 0 0 834
3endofthelinebbs-out.news.weretis.net 467 1 0 1 0 0 0 0 465
4newsfeed.xs3.de 11 0 0 0 0 0 0 0 11
5news.samoylyk.net 1 0 0 0 0 0 0 0 1
TOTAL: 5 2386 85 0 2 0 0 0 0 2299

Unwanted newsgroups [Top 20]:

NewsgroupCount
talk.english.tg 55
talk.generic.ua.ws 11
rocksolid.feeds.news 4
panix.test 4
talk.english.tw 2
alt.test.ok 2
al.christnet.bible 2
news.oriens-occasus.ru 1
talk.from.diary 1
grisbi.test 1
fr.petites-annonces.informatique.materiel 1
talk.from.war.diary 1
TOTAL: 12 85

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 766
EMP (phn path) 763
Too many newsgroups 208
EMP (phn nph) 156
EMP (phl) 81
HTML Multipart 9
Scoring filter 4
TOTAL: 7 1987

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
endofthelinebbs-out.news.weretis.net 253
peer.alt119.net 28
usenet.blueworldhosting.com 22
newsfeed.xs3.de 9
TOTAL: 4 312
TOTAL: 1 312

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1peer.alt119.net 9033 1008 6961 5 0 5 11%23:59:55
2news.bbs.nz 18980 765 9219 128 0 11 4%23:59:58
3news.nk.ca 13460 240 9813 67 0 27 1%23:59:58
4news.quux.org 10673 99 9890 116 0 0 0%23:59:58
5news.furie.org.uk 7923 64 5340 10 0 0 0%23:59:53
6usenet.blueworldhosting.com 7794 12 6977 2 0 0 0%23:59:58
7news.weretis.net 10279 9 10122 0 0 0 0%23:59:58
8newsfeed.xs3.de 12510 8 9892 4 0 0 0%23:59:58
9news.tnetconsulting.net 11284 2 10127 0 0 0 0%23:58:47
10news.samoylyk.net 12707 0 10103 1 0 0 0%23:59:35
TOTAL: 10 114643 2207 88444 333 0 43 1%239:57:58
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1peer.alt119.net6.9 MB19.2 KB6.9 MB0.1 KB/s7.0 KB23:59:55
2news.bbs.nz4.1 MB969.6 KB5.1 MB0.1 KB/s5.8 KB23:59:58
3news.nk.ca3.0 MB202.2 KB3.2 MB0.0 KB/s10.7 KB23:59:58
4news.quux.org1.5 MB920.2 KB2.4 MB0.0 KB/s11.6 KB23:59:58
5news.furie.org.uk830.0 KB103.9 KB933.9 KB0.0 KB/s12.6 KB23:59:53
6usenet.blueworldhosting.com18.1 KB2.5 KB20.6 KB0.0 KB/s1.5 KB23:59:58
7news.weretis.net12.2 KB0.0 KB12.2 KB0.0 KB/s1.4 KB23:59:58
8newsfeed.xs3.de9.5 KB6.3 KB15.7 KB0.0 KB/s1.3 KB23:59:58
9news.tnetconsulting.net8.2 KB0.0 KB8.2 KB0.0 KB/s4.1 KB23:58:47
10news.samoylyk.net0.0 KB2.9 KB2.9 KB0.0 KB/s2.9 KB23:59:35
TOTAL: 1016.4 MB2.2 MB18.6 MB0.0 KB/s7.5 KB239:57:58
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1192.241.223.66 1 00.0 KB 0 0 000:00:00
2ns31410046.ip-145-239-154.eu 4 00.0 KB 0 0 000:00:03
TOTAL: 2 5 00.0 KB 0 0 000:00:03

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.ip-145-239-154.eu 4 00.0 KB 0 0 000:00:03
2unresolved 1 00.0 KB 0 0 000:00:00
TOTAL: 2 5 00.0 KB 0 0 000:00:03

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
ns31410046.ip-145-239-154.eu 0.264 0.120 0.00000:00:03
192.241.223.66 0.089 0.033 0.00000:00:00
TOTAL: 2 0.353 0.153 0.00000:00:03

NNRP unrecognized commands (by host):

SystemConn
ns31410046.ip-145-239-154.eu 4
192.241.223.66 1
TOTAL: 2 5

NNRP unrecognized commands (by command):

CommandCount
#026#003#001 1
À#024 1
#026#003 1
#026#003#001#002 1
MGLNDD_192.138.210.162_119 1
TOTAL: 5 5

NNRP client timeouts [Top 20]:

SystemConnPeer
ns31410046.ip-145-239-154.eu 1 1
TOTAL: 1 1 1