Daily Usenet report

Jul 11 03:00:05 -- Jul 12 03:00:04

Unknown entries from news log file:

First 50 / 593 lines (8.4%)

Jul 11 03:01:24 twilightnode innd: message repeated 2 times: [ ctlinnd command s]
Jul 11 07:58:05 twilightnode nnrpd[3633855]: Reading access from /usr/local/news/etc/readers.conf
Jul 11 07:58:05 twilightnode nnrpd[3633855]: Auth strategy 'localhost' does not match client. Removing.
Jul 11 07:58:05 twilightnode nnrpd[3633855]: 69.5.169.212 res <anonymous>
Jul 11 07:58:05 twilightnode nnrpd[3633855]: 69.5.169.212 no_match_user <anonymous> <localhost>
Jul 11 07:58:05 twilightnode nnrpd[3633855]: 69.5.169.212 no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 11 07:58:05 twilightnode nnrpd[3633855]: 69.5.169.212 match_user <anonymous> <anonymous>
Jul 11 07:58:05 twilightnode nnrpd[3633855]: 69.5.169.212 no_post anonymous-read
Jul 11 07:58:16 twilightnode nnrpd[3633856]: Reading access from /usr/local/news/etc/readers.conf
Jul 11 07:58:16 twilightnode nnrpd[3633856]: Auth strategy 'localhost' does not match client. Removing.
Jul 11 07:58:16 twilightnode nnrpd[3633856]: 69.5.169.13 res <anonymous>
Jul 11 07:58:16 twilightnode nnrpd[3633856]: 69.5.169.13 no_match_user <anonymous> <localhost>
Jul 11 07:58:16 twilightnode nnrpd[3633856]: 69.5.169.13 no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 11 07:58:16 twilightnode nnrpd[3633856]: 69.5.169.13 match_user <anonymous> <anonymous>
Jul 11 07:58:16 twilightnode nnrpd[3633856]: 69.5.169.13 no_post anonymous-read
Jul 11 09:21:55 twilightnode nnrpd[3637231]: Reading access from /usr/local/news/etc/readers.conf
Jul 11 09:21:55 twilightnode nnrpd[3637231]: Auth strategy 'localhost' does not match client. Removing.
Jul 11 09:21:55 twilightnode nnrpd[3637231]: azpdesrz0wxn.stretchoid.com res <anonymous>
Jul 11 09:21:55 twilightnode nnrpd[3637231]: azpdesrz0wxn.stretchoid.com no_match_user <anonymous> <localhost>
Jul 11 09:21:55 twilightnode nnrpd[3637231]: azpdesrz0wxn.stretchoid.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 11 09:21:55 twilightnode nnrpd[3637231]: azpdesrz0wxn.stretchoid.com match_user <anonymous> <anonymous>
Jul 11 09:21:55 twilightnode nnrpd[3637231]: azpdesrz0wxn.stretchoid.com no_post anonymous-read
Jul 11 09:22:05 twilightnode nnrpd[3637238]: Reading access from /usr/local/news/etc/readers.conf
Jul 11 09:22:05 twilightnode nnrpd[3637238]: Auth strategy 'localhost' does not match client. Removing.
Jul 11 09:22:05 twilightnode nnrpd[3637238]: azpdesrz0wxn.stretchoid.com res <anonymous>
Jul 11 09:22:05 twilightnode nnrpd[3637238]: azpdesrz0wxn.stretchoid.com no_match_user <anonymous> <localhost>
Jul 11 09:22:05 twilightnode nnrpd[3637238]: azpdesrz0wxn.stretchoid.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 11 09:22:05 twilightnode nnrpd[3637238]: azpdesrz0wxn.stretchoid.com match_user <anonymous> <anonymous>
Jul 11 09:22:05 twilightnode nnrpd[3637238]: azpdesrz0wxn.stretchoid.com no_post anonymous-read
Jul 11 20:47:12 twilightnode nnrpd[3666088]: Reading access from /usr/local/news/etc/readers.conf
Jul 11 20:47:12 twilightnode nnrpd[3666088]: Auth strategy 'localhost' does not match client. Removing.
Jul 11 20:47:12 twilightnode nnrpd[3666088]: calum.probe.onyphe.net res <anonymous>
Jul 11 20:47:12 twilightnode nnrpd[3666088]: calum.probe.onyphe.net no_match_user <anonymous> <localhost>
Jul 11 20:47:12 twilightnode nnrpd[3666088]: calum.probe.onyphe.net no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 11 20:47:12 twilightnode nnrpd[3666088]: calum.probe.onyphe.net match_user <anonymous> <anonymous>
Jul 11 20:47:12 twilightnode nnrpd[3666088]: calum.probe.onyphe.net no_post anonymous-read
Jul 11 20:47:13 twilightnode nnrpd[3666089]: Reading access from /usr/local/news/etc/readers.conf
Jul 11 20:47:13 twilightnode nnrpd[3666089]: Auth strategy 'localhost' does not match client. Removing.
Jul 11 20:47:13 twilightnode nnrpd[3666089]: ferguson.probe.onyphe.net res <anonymous>
Jul 11 20:47:13 twilightnode nnrpd[3666089]: ferguson.probe.onyphe.net no_match_user <anonymous> <localhost>
Jul 11 20:47:13 twilightnode nnrpd[3666089]: ferguson.probe.onyphe.net no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 11 20:47:13 twilightnode nnrpd[3666089]: ferguson.probe.onyphe.net match_user <anonymous> <anonymous>
Jul 11 20:47:13 twilightnode nnrpd[3666089]: ferguson.probe.onyphe.net no_post anonymous-read
Jul 11 21:33:52 twilightnode nnrpd[3667853]: Reading access from /usr/local/news/etc/readers.conf
Jul 11 21:33:52 twilightnode nnrpd[3667853]: Auth strategy 'localhost' does not match client. Removing.
Jul 11 21:33:52 twilightnode nnrpd[3667853]: 81.195.132.66.censys-scanner.com res <anonymous>
Jul 11 21:33:52 twilightnode nnrpd[3667853]: 81.195.132.66.censys-scanner.com no_match_user <anonymous> <localhost>
Jul 11 21:33:52 twilightnode nnrpd[3667853]: 81.195.132.66.censys-scanner.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 11 21:33:52 twilightnode nnrpd[3667853]: 81.195.132.66.censys-scanner.com match_user <anonymous> <anonymous>
Jul 11 21:33:52 twilightnode nnrpd[3667853]: 81.195.132.66.censys-scanner.com no_post anonymous-read

Log entries by program:

Program nameLines%LinesSize%Size
innfeed 35118 81.2%4.8 MB 76.8%
inn 5991 13.8%1.1 MB 18.2%
innd 1268 2.9%232.0 KB 3.6%
nnrpd 887 2.0%86.3 KB 1.4%
controlchan 6 0.0%0.4 KB 0.0%
rnews 2 0.0%0.2 KB 0.0%
TOTAL: 6 43272 100.0%6.2 MB100.0%

History cache:

ReasonCount%Count
Positive hits 13385 50.3%
Negative hits 7401 27.8%
Do not exist 5820 21.9%
Cache misses 18 0.1%
TOTAL: 4 26624 100.0%

innd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.003 0.0%1 3.000 3.000 3.000
article cleanup00:00:00.084 0.0%5853 0.000 0.014 0.208
article logging00:00:00.210 0.0%5862 0.000 0.036 0.167
article parse00:00:00.095 0.0%9386 0.000 0.010 0.095
article write00:00:05.107 0.0%4362 0.375 1.171 2.600
data move00:00:00.126 0.0%29067 0.000 0.004 0.038
hisgrep/artcncl00:00:00.001 0.0%1 1.000 1.000 1.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:05.527 0.0%26778 0.068 0.206 1.942
history sync00:00:00.068 0.0%361 0.000 0.188 1.000
history write00:00:03.470 0.0%5853 0.143 0.593 1.250
idle21:09:53.856 99.9%28454 601.259 2677.791 19370.419
nntp read00:00:00.699 0.0%27993 0.000 0.025 0.095
overview write00:00:02.543 0.0%4362 0.109 0.583 2.250
perl filter00:00:10.902 0.0%5853 0.903 1.863 14.458
python filter00:00:00.637 0.0%5853 0.000 0.109 1.333
site send00:00:00.116 0.0%4362 0.000 0.027 0.160
TOTAL: 1721:10:23.444 99.9%----

innfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.030 0.0%20655 0.000 0.001 0.067
article prepare00:00:00.003 0.0%18708 0.000 0.000 0.008
article read00:00:01.555 0.0%4677 0.000 0.332 1.500
backlog stats00:00:00.080 0.0%62271 0.000 0.001 0.012
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:00.716 0.0%29904 0.000 0.024 0.133
data write00:00:00.761 0.0%25718 0.000 0.030 0.079
idle20:47:20.794100.0%62271 97.012 1201.856 5919.089
status file00:00:08.664 0.0%14355 0.200 0.604 5.000
TOTAL: 920:47:32.603100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:11:45.132100.0%212 41.000 3326.094 11005.500
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.042 0.0%3592 0.000 0.012 0.500
TOTAL: 300:11:45.174100.0%----

Control commands to innd:

CommandNumber
feedinfo 1
flush 3
flushlogs 2
go 2
logmode 2
lowmark 1
mode 162
name 24
pause 2
paused 2
reload 14
reserve 2
xexec 1
TOTAL: 13 218

Incoming feeds (innd):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1twilightnode-out.news.weretis.net 8 10650 3896 5693 1061 36%44:18:09
2newsfeed.endofthelinebbs.com 5 3323 227 2775 321 6%14:33:39
3news.tebibyte.org 2 5671 64 5586 21 1%23:58:51
4news.sklaffkom.se 30 77 19 21 37 24%08:02:39
5localhost 23 0 0 0 0 0%00:00:29
TOTAL: 5 68 19721 4206 14075 1440 21%90:53:47
Articles received by server

Incoming volume (innd):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1twilightnode-out.news.weretis.net14.1 MB0.0 KB3.1 MB17.2 MB 81%3.6 KB
2newsfeed.endofthelinebbs.com4.5 MB0.0 KB1.1 MB5.7 MB 79%10.6 KB
3news.tebibyte.org214.1 KB0.0 KB52.0 KB266.1 KB 80%3.1 KB
4news.sklaffkom.se50.3 KB0.0 KB87.0 KB137.3 KB 36%2.5 KB
5localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 518.9 MB0.0 KB4.4 MB23.3 MB 81%4.2 KB
Incoming volume received by server

Incoming articles (innd):

DateArticles%ArtsArt/secSize%SizeKB/sec
Jul 11 03:00:05 - 03:59:59 81 1.8% 0.02317.0 KB 0.0% 0.09
Jul 11 04:00:00 - 04:59:59 115 2.6% 0.03437.6 KB 8.1% 0.12
Jul 11 05:00:00 - 05:59:59 87 2.0% 0.02271.9 KB 5.1% 0.08
Jul 11 06:00:00 - 06:59:59 135 3.0% 0.04586.4 KB 10.9% 0.16
Jul 11 07:00:00 - 07:59:59 124 2.8% 0.03356.6 KB 6.6% 0.10
Jul 11 08:00:00 - 08:59:59 154 3.5% 0.04639.2 KB 11.9% 0.18
Jul 11 09:00:00 - 09:59:59 221 5.0% 0.06938.3 KB 17.4% 0.26
Jul 11 10:00:00 - 10:59:59 229 5.2% 0.06679.5 KB 12.6% 0.19
Jul 11 11:00:00 - 11:59:59 242 5.5% 0.07819.4 KB 15.2% 0.23
Jul 11 12:00:00 - 12:59:59 249 5.6% 0.072.9 MB 54.9% 0.82
Jul 11 13:00:00 - 13:59:59 358 8.1% 0.105.3 MB 100.0% 1.49
Jul 11 14:00:00 - 14:59:59 195 4.4% 0.05591.1 KB 11.0% 0.16
Jul 11 15:00:00 - 15:59:59 318 7.2% 0.091.1 MB 20.9% 0.31
Jul 11 16:00:00 - 16:59:59 198 4.5% 0.06750.9 KB 14.0% 0.21
Jul 11 17:00:00 - 17:59:59 224 5.1% 0.06689.7 KB 12.8% 0.19
Jul 11 18:00:00 - 18:59:59 209 4.7% 0.06687.8 KB 12.8% 0.19
Jul 11 19:00:00 - 19:59:59 186 4.2% 0.05583.8 KB 10.9% 0.16
Jul 11 20:00:00 - 20:59:59 226 5.1% 0.06653.3 KB 12.1% 0.18
Jul 11 21:00:00 - 21:59:59 175 3.9% 0.05579.9 KB 10.8% 0.16
Jul 11 22:00:00 - 22:59:59 166 3.7% 0.05512.8 KB 9.5% 0.14
Jul 11 23:00:00 - 23:59:59 53 1.2% 0.01184.9 KB 3.4% 0.05
Jul 12 00:00:00 - 00:59:59 0 0.0% 0.000.0 KB 0.0% 0.00
Jul 12 01:00:00 - 01:59:59 340 7.7% 0.091.0 MB 19.8% 0.30
Jul 12 02:00:00 - 02:59:59 135 3.0% 0.04594.9 KB 11.1% 0.17
Jul 12 03:00:00 - 03:00:04 11 0.2% 2.7511.3 KB 0.2% 2.82
TOTAL: 23:59:59 4431 100.0% 0.055.3 MB 100.0% 0.06
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1twilightnode-out.news.weretis.net 1079 993 0 0 0 0 0 0 86
2newsfeed.endofthelinebbs.com 411 70 0 0 0 0 0 0 341
3news.sklaffkom.se 37 37 0 0 0 0 0 0 0
4news.tebibyte.org 33 28 0 0 0 0 0 0 5
TOTAL: 4 1560 1128 0 0 0 0 0 0 432

Unwanted newsgroups [Top 20]:

NewsgroupCount
de.etc.finanz.banken+broker 50
alt.usage.english 37
aus.politics 36
pl.pregierz 36
de.comm.internet.telefonie 31
alt.recovery.aa 30
hfx.general 29
alt.slack 26
uk.legal.moderated 25
alt.prophecies.nostradamus 23
eternal-september.talk 21
cn.comp 19
de.comp.hardware.netzwerke.misc 19
de.talk.jokes 19
pl.soc.prawo 19
fido7.su.hardw.other 18
alt.checkmate 16
can.politics 15
de.comm.software.newsreader 15
alt.support.depression 13
TOTAL: 211 1128

Perl filter (innd) [Top 20]:

ReasonCount
EMP (md5) 341
EMP (phl) 40
User-issued cancel 18
EMP (phn path) 14
Too many newsgroups 7
Too many newsgroups (meow) 3
TOTAL: 6 423

Miscellaneous innd events:

EventsCount
CCreader 2
TOTAL: 1 2

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Bad command received
localhost 2
TOTAL: 1 2
Including strange strings
twilightnode-out.news.weretis.net 9
TOTAL: 1 9
TOTAL: 2 11

Outgoing feeds (innfeed) by articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1sklaffkom.se 4810 740 2391 1292 0 9 15%21:19:34
2newsfeed.endofthelinebbs.com 95553 160 66310 26619 0 6433 0%21:19:33
3news.tebibyte.org 2385 0 0 0 0 6809 0%21:20:01
4weretis.net 421 0 414 0 0 9 0%16:19:19
5chimia.se 0 0 0 0 0 4378 0%20:34:56
6sklaff.dev 0 0 0 0 0 4372 0%20:25:51
7thebunker.nu 0 0 0 0 0 4378 0%20:43:38
8usenet.blueworldhosting.com 0 0 0 0 0 3888 0%20:43:38
TOTAL: 8 103169 900 69115 27911 0 30276 0%162:46:30
Outgoing feeds (innfeed) by articles

Outgoing feeds (innfeed) by volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1sklaffkom.se1.2 MB7.2 MB8.4 MB0.1 KB/s4.2 KB21:19:34
2newsfeed.endofthelinebbs.com284.1 KB55.6 MB55.9 MB0.7 KB/s2.1 KB21:19:33
3chimia.se0.0 KB0.0 KB0.0 KB0.0 KB/s020:34:56
4news.tebibyte.org0.0 KB0.0 KB0.0 KB0.0 KB/s021:20:01
5sklaff.dev0.0 KB0.0 KB0.0 KB0.0 KB/s020:25:51
6thebunker.nu0.0 KB0.0 KB0.0 KB0.0 KB/s020:43:38
7usenet.blueworldhosting.com0.0 KB0.0 KB0.0 KB0.0 KB/s020:43:38
8weretis.net0.0 KB0.0 KB0.0 KB0.0 KB/s016:19:19
TOTAL: 81.5 MB62.8 MB64.3 MB0.1 KB/s2.3 KB162:46:30
Outgoing feeds (innfeed) by volume

NNRP readership statistics [Top 100]:

SystemConnArtsSizeGroupsPostRejElapsed
181.2.118.99 65 00.0 KB 0 0 000:10:40
2195-252-55-9-no600.tbcn.telia.com 2 00.0 KB 0 0 000:00:46
3azpdesrz0wxn.stretchoid.com 2 00.0 KB 0 0 000:00:10
469.5.169.13 1 00.0 KB 0 0 000:00:00
569.5.169.212 1 00.0 KB 0 0 000:00:00
681.195.132.66.censys-scanner.com 1 00.0 KB 0 0 000:00:02
7calum.probe.onyphe.net 1 00.0 KB 0 0 000:00:01
8ferguson.probe.onyphe.net 1 00.0 KB 0 0 000:00:03
TOTAL: 8 74 00.0 KB 0 0 000:11:45

NNRP connection statistics (by domain) [Top 100]:

SystemConnArtsSizeGroupsPostRejElapsed
1unresolved 67 00.0 KB 0 0 000:10:40
2*.probe.onyphe.net 2 00.0 KB 0 0 000:00:04
3*.stretchoid.com 2 00.0 KB 0 0 000:00:10
4*.tbcn.telia.com 2 00.0 KB 0 0 000:00:46
5*.66.censys-scanner.com 1 00.0 KB 0 0 000:00:02
TOTAL: 5 74 00.0 KB 0 0 000:11:45

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
81.2.118.99 0.241 0.331 0.00000:10:40
195-252-55-9-no600.tbcn.telia.com 0.010 0.013 0.00000:00:46
azpdesrz0wxn.stretchoid.com 0.007 0.020 0.00000:00:10
ferguson.probe.onyphe.net 0.005 0.004 0.00000:00:03
81.195.132.66.censys-scanner.com 0.033 0.014 0.00000:00:02
calum.probe.onyphe.net 0.003 0.018 0.00000:00:01
69.5.169.13 0.004 0.006 0.00000:00:00
69.5.169.212 0.002 0.017 0.00000:00:00
TOTAL: 8 0.305 0.423 0.00000:11:45

NNRP unrecognized commands (by host) [Top 20]:

SystemConn
calum.probe.onyphe.net 2
195-252-55-9-no600.tbcn.telia.com 1
81.195.132.66.censys-scanner.com 1
azpdesrz0wxn.stretchoid.com 1
TOTAL: 4 5

NNRP unrecognized commands (by command) [Top 20]:

CommandCount
#026#003#003#002c#001 1
?$?,?r?s?#023#002#023#001?#024?#007?#022?#023?'?/?#024?(?0?`?a... 1
EHLO www.censys.io 1
MGLNDD_172.234.115.63_119 1
exit 1
TOTAL: 5 5

NNRP client timeouts [Top 20]:

SystemConnPeer
69.5.169.13 1 1
TOTAL: 1 1 2
innreport from INN 2.7.3 based on initial work (©) 1996-2001 by Fabien Tassin <fta@sofaraway.org> and enhanced by several contributors since then