Daily Usenet report

Jul 29 03:00:05 -- Jul 30 03:00:05

Unknown entries from news log file:

First 50 / 69 lines (72.5%)

Jul 29 03:01:21 twilightnode innd: message repeated 2 times: [ ctlinnd command s]
Jul 29 06:41:10 twilightnode nnrpd[227439]: Reading access from /usr/local/news/etc/readers.conf
Jul 29 06:41:10 twilightnode nnrpd[227439]: Auth strategy 'localhost' does not match client. Removing.
Jul 29 06:41:10 twilightnode nnrpd[227439]: azpdcs5lfrbl.stretchoid.com res <anonymous>
Jul 29 06:41:10 twilightnode nnrpd[227439]: azpdcs5lfrbl.stretchoid.com no_match_user <anonymous> <localhost>
Jul 29 06:41:10 twilightnode nnrpd[227439]: azpdcs5lfrbl.stretchoid.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 29 06:41:10 twilightnode nnrpd[227439]: azpdcs5lfrbl.stretchoid.com match_user <anonymous> <anonymous>
Jul 29 06:41:10 twilightnode nnrpd[227439]: azpdcs5lfrbl.stretchoid.com no_post anonymous-read
Jul 29 06:41:21 twilightnode nnrpd[227440]: Reading access from /usr/local/news/etc/readers.conf
Jul 29 06:41:21 twilightnode nnrpd[227440]: Auth strategy 'localhost' does not match client. Removing.
Jul 29 06:41:21 twilightnode nnrpd[227440]: azpdcs5lfrbl.stretchoid.com res <anonymous>
Jul 29 06:41:21 twilightnode nnrpd[227440]: azpdcs5lfrbl.stretchoid.com no_match_user <anonymous> <localhost>
Jul 29 06:41:21 twilightnode nnrpd[227440]: azpdcs5lfrbl.stretchoid.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 29 06:41:21 twilightnode nnrpd[227440]: azpdcs5lfrbl.stretchoid.com match_user <anonymous> <anonymous>
Jul 29 06:41:21 twilightnode nnrpd[227440]: azpdcs5lfrbl.stretchoid.com no_post anonymous-read
Jul 29 12:30:56 twilightnode nnrpd[243893]: Reading access from /usr/local/news/etc/readers.conf
Jul 29 12:30:56 twilightnode nnrpd[243893]: Auth strategy 'localhost' does not match client. Removing.
Jul 29 12:30:56 twilightnode nnrpd[243893]: 198.235.24.89 res <anonymous>
Jul 29 12:30:56 twilightnode nnrpd[243893]: 198.235.24.89 no_match_user <anonymous> <localhost>
Jul 29 12:30:56 twilightnode nnrpd[243893]: 198.235.24.89 no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 29 12:30:56 twilightnode nnrpd[243893]: 198.235.24.89 match_user <anonymous> <anonymous>
Jul 29 12:30:56 twilightnode nnrpd[243893]: 198.235.24.89 no_post anonymous-read
Jul 29 13:04:57 twilightnode nnrpd[245360]: Reading access from /usr/local/news/etc/readers.conf
Jul 29 13:04:57 twilightnode nnrpd[245360]: Auth strategy 'localhost' does not match client. Removing.
Jul 29 13:04:57 twilightnode nnrpd[245360]: marshall.probe.onyphe.net res <anonymous>
Jul 29 13:04:57 twilightnode nnrpd[245360]: marshall.probe.onyphe.net no_match_user <anonymous> <localhost>
Jul 29 13:04:57 twilightnode nnrpd[245360]: marshall.probe.onyphe.net no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 29 13:04:57 twilightnode nnrpd[245360]: marshall.probe.onyphe.net match_user <anonymous> <anonymous>
Jul 29 13:04:57 twilightnode nnrpd[245360]: marshall.probe.onyphe.net no_post anonymous-read
Jul 29 13:04:58 twilightnode nnrpd[245361]: Reading access from /usr/local/news/etc/readers.conf
Jul 29 13:04:58 twilightnode nnrpd[245361]: Auth strategy 'localhost' does not match client. Removing.
Jul 29 13:04:58 twilightnode nnrpd[245361]: marshall.probe.onyphe.net res <anonymous>
Jul 29 13:04:58 twilightnode nnrpd[245361]: marshall.probe.onyphe.net no_match_user <anonymous> <localhost>
Jul 29 13:04:58 twilightnode nnrpd[245361]: marshall.probe.onyphe.net no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 29 13:04:58 twilightnode nnrpd[245361]: marshall.probe.onyphe.net match_user <anonymous> <anonymous>
Jul 29 13:04:58 twilightnode nnrpd[245361]: marshall.probe.onyphe.net no_post anonymous-read
Jul 29 16:06:16 twilightnode nnrpd[253395]: Reading access from /usr/local/news/etc/readers.conf
Jul 29 16:06:16 twilightnode nnrpd[253395]: Auth strategy 'localhost' does not match client. Removing.
Jul 29 16:06:16 twilightnode nnrpd[253395]: azpdcgcto85s.stretchoid.com res <anonymous>
Jul 29 16:06:16 twilightnode nnrpd[253395]: azpdcgcto85s.stretchoid.com no_match_user <anonymous> <localhost>
Jul 29 16:06:16 twilightnode nnrpd[253395]: azpdcgcto85s.stretchoid.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 29 16:06:16 twilightnode nnrpd[253395]: azpdcgcto85s.stretchoid.com match_user <anonymous> <anonymous>
Jul 29 16:06:16 twilightnode nnrpd[253395]: azpdcgcto85s.stretchoid.com no_post anonymous-read
Jul 29 16:06:26 twilightnode nnrpd[253396]: Reading access from /usr/local/news/etc/readers.conf
Jul 29 16:06:26 twilightnode nnrpd[253396]: Auth strategy 'localhost' does not match client. Removing.
Jul 29 16:06:26 twilightnode nnrpd[253396]: azpdcgcto85s.stretchoid.com res <anonymous>
Jul 29 16:06:26 twilightnode nnrpd[253396]: azpdcgcto85s.stretchoid.com no_match_user <anonymous> <localhost>
Jul 29 16:06:26 twilightnode nnrpd[253396]: azpdcgcto85s.stretchoid.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Jul 29 16:06:26 twilightnode nnrpd[253396]: azpdcgcto85s.stretchoid.com match_user <anonymous> <anonymous>
Jul 29 16:06:26 twilightnode nnrpd[253396]: azpdcgcto85s.stretchoid.com no_post anonymous-read

Log entries by program:

Program nameLines%LinesSize%Size
inn 6567 72.6%989.3 KB 72.6%
innd 1197 13.2%178.5 KB 13.1%
innfeed 1179 13.0%182.7 KB 13.4%
nnrpd 106 1.2%11.3 KB 0.8%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 5 9050 100.0%1.3 MB100.0%

History cache:

ReasonCount%Count
Positive hits 14387 48.5%
Negative hits 8773 29.6%
Do not exist 6509 21.9%
Cache misses 4 0.0%
TOTAL: 4 29673 100.0%

innd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.006 0.0%4 0.500 1.500 2.500
article cleanup00:00:00.045 0.0%6542 0.000 0.007 0.050
article logging00:00:00.193 0.0%6569 0.000 0.029 0.154
article parse00:00:00.089 0.0%8924 0.000 0.010 0.056
article write00:00:04.117 0.0%4770 0.333 0.863 4.550
data move00:00:00.100 0.0%32614 0.000 0.003 0.027
hisgrep/artcncl00:00:00.005 0.0%4 0.000 1.250 2.500
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:04.219 0.0%29807 0.073 0.142 0.419
history sync00:00:00.030 0.0%325 0.000 0.092 1.000
history write00:00:03.098 0.0%6542 0.143 0.474 1.000
idle24:00:03.788100.0%31943 1404.902 2704.937 10528.526
nntp read00:00:00.582 0.0%31691 0.000 0.018 0.059
overview write00:00:02.129 0.0%4770 0.154 0.446 2.476
perl filter00:00:07.555 0.0%6542 0.538 1.155 6.407
python filter00:00:00.473 0.0%6542 0.000 0.072 0.321
site send00:00:00.107 0.0%4770 0.000 0.022 0.167
TOTAL: 1724:00:26.536100.0%----

innfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.006 0.0%4934 0.000 0.001 0.048
article prepare00:00:00.002 0.0%16524 0.000 0.000 0.009
article read00:00:00.490 0.0%3209 0.000 0.153 1.000
backlog stats00:00:00.029 0.0%52943 0.000 0.001 0.009
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:00.360 0.0%28652 0.000 0.013 0.047
data write00:00:00.633 0.0%23758 0.000 0.027 0.130
idle23:49:56.945100.0%52943 360.706 1620.553 5727.019
status file00:00:00.118 0.0%200 0.000 0.590 7.000
TOTAL: 923:49:58.583100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:35.748100.0%14 73.000 2553.429 10597.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.000 0.0%34 0.000 0.000 0.000
TOTAL: 300:00:35.748100.0%----

Control commands to innd:

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

Incoming feeds (innd):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1twilightnode-out.news.weretis.net 3 10950 4062 5719 1169 37%47:40:51
2newsfeed.endofthelinebbs.com 3 5236 574 4174 488 10%26:17:08
3news.tebibyte.org 2 4744 146 4553 45 3%23:59:41
4news.sklaffkom.se 28 65 22 9 34 33%07:01:23
5localhost 25 0 0 0 0 0%00:00:00
TOTAL: 5 61 20995 4804 14455 1736 22%104:59:03
Articles received by server

Incoming volume (innd):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1twilightnode-out.news.weretis.net11.2 MB0.0 KB3.9 MB15.1 MB 74%3.0 KB
2newsfeed.endofthelinebbs.com5.3 MB0.0 KB795.1 KB6.1 MB 87%5.9 KB
3news.tebibyte.org479.7 KB0.0 KB180.7 KB660.4 KB 72%3.5 KB
4news.sklaffkom.se60.8 KB0.0 KB71.7 KB132.5 KB 45%2.4 KB
5localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 517.1 MB0.0 KB4.9 MB22.0 MB 77%3.4 KB
Incoming volume received by server

Incoming articles (innd):

DateArticles%ArtsArt/secSize%SizeKB/sec
Jul 29 03:00:05 - 03:59:59 94 2.0% 0.03341.4 KB 2.0% 0.09
Jul 29 04:00:00 - 04:59:59 126 2.6% 0.04502.2 KB 2.9% 0.14
Jul 29 05:00:00 - 05:59:59 120 2.5% 0.03504.2 KB 2.9% 0.14
Jul 29 06:00:00 - 06:59:59 113 2.4% 0.03373.8 KB 2.2% 0.10
Jul 29 07:00:00 - 07:59:59 154 3.2% 0.04433.8 KB 2.5% 0.12
Jul 29 08:00:00 - 08:59:59 229 4.8% 0.06788.3 KB 4.6% 0.22
Jul 29 09:00:00 - 09:59:59 265 5.6% 0.07831.3 KB 4.8% 0.23
Jul 29 10:00:00 - 10:59:59 254 5.3% 0.07685.9 KB 4.0% 0.19
Jul 29 11:00:00 - 11:59:59 260 5.5% 0.07879.3 KB 5.1% 0.24
Jul 29 12:00:00 - 12:59:59 232 4.9% 0.061.2 MB 7.0% 0.33
Jul 29 13:00:00 - 13:59:59 198 4.2% 0.06639.0 KB 3.7% 0.18
Jul 29 14:00:00 - 14:59:59 197 4.1% 0.05774.9 KB 4.5% 0.22
Jul 29 15:00:00 - 15:59:59 257 5.4% 0.07751.4 KB 4.4% 0.21
Jul 29 16:00:00 - 16:59:59 285 6.0% 0.08998.9 KB 5.8% 0.28
Jul 29 17:00:00 - 17:59:59 241 5.1% 0.07899.0 KB 5.2% 0.25
Jul 29 18:00:00 - 18:59:59 232 4.9% 0.06733.0 KB 4.2% 0.20
Jul 29 19:00:00 - 19:59:59 227 4.8% 0.06748.7 KB 4.3% 0.21
Jul 29 20:00:00 - 20:59:59 263 5.5% 0.07850.5 KB 4.9% 0.24
Jul 29 21:00:00 - 21:59:59 228 4.8% 0.06782.2 KB 4.5% 0.22
Jul 29 22:00:00 - 22:59:59 215 4.5% 0.061.1 MB 6.2% 0.30
Jul 29 23:00:00 - 23:59:59 181 3.8% 0.05736.3 KB 4.3% 0.20
Jul 30 00:00:00 - 00:59:59 171 3.6% 0.05778.9 KB 4.5% 0.22
Jul 30 01:00:00 - 01:59:59 126 2.6% 0.04532.6 KB 3.1% 0.15
Jul 30 02:00:00 - 02:59:59 88 1.8% 0.02389.5 KB 2.3% 0.11
Jul 30 03:00:00 - 03:00:05 12 0.3% 2.4015.1 KB 0.1% 3.02
TOTAL: 24:00:00 4768 100.0% 0.0616.8 MB 100.0% 0.20
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1twilightnode-out.news.weretis.net 1226 1147 0 0 0 0 0 0 79
2newsfeed.endofthelinebbs.com 468 48 0 0 0 0 0 0 420
3news.tebibyte.org 72 69 0 0 0 0 0 0 3
4news.sklaffkom.se 33 33 0 0 0 0 0 0 0
TOTAL: 4 1799 1297 0 0 0 0 0 0 502

Unwanted newsgroups [Top 20]:

NewsgroupCount
pl.misc.elektronika 66
linux.debian.vote 59
alt.usage.english 54
alt.checkmate 43
hfx.general 43
alt.fan.rush-limbaurgh 39
uk.net.news.moderation 36
lada.talk 32
it.tlc.cellulari.android 29
de.alt.talk.unmut 28
pl.soc.prawo 28
uk.religion.christian 26
alt.prophecies.nostradamus 22
de.etc.haushalt 21
eternal-september.talk 21
alt.home.repair 20
cn.comp 20
de.comm.provider.mail 20
muc.lists.freebsd.bugs 18
it.hobby.cucina 17
TOTAL: 206 1297

Perl filter (innd) [Top 20]:

ReasonCount
EMP (md5) 425
User-issued cancel 37
Too many newsgroups 7
Too many newsgroups (meow) 4
HTML Multipart 2
TOTAL: 5 475

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
twilightnode-out.news.weretis.net 27
TOTAL: 1 27
TOTAL: 1 27

Outgoing feeds (innfeed) by articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.tebibyte.org 6725 944 3826 1 0 12 14%23:59:28
2sklaffkom.se 4951 779 1591 2398 0 1 15%23:59:33
3newsfeed.endofthelinebbs.com 8175 17 4191 4 0 174 0%23:59:43
4weretis.net 717 0 704 0 0 0 0%23:30:11
TOTAL: 4 20568 1740 10312 2403 0 187 8%95:28:55
Outgoing feeds (innfeed) by articles

Outgoing feeds (innfeed) by volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.tebibyte.org2.9 MB1.3 KB2.9 MB0.0 KB/s3.1 KB23:59:28
2sklaffkom.se1.4 MB10.6 MB12.0 MB0.1 KB/s3.9 KB23:59:33
3newsfeed.endofthelinebbs.com44.8 KB13.5 KB58.3 KB0.0 KB/s2.8 KB23:59:43
4weretis.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:30:11
TOTAL: 44.4 MB10.6 MB15.0 MB0.0 KB/s3.7 KB95:28:55
Outgoing feeds (innfeed) by volume

NNRP readership statistics [Top 100]:

SystemConnArtsSizeGroupsPostRejElapsed
1azpdcgcto85s.stretchoid.com 2 00.0 KB 0 0 000:00:10
2azpdcs5lfrbl.stretchoid.com 2 00.0 KB 0 0 000:00:10
3marshall.probe.onyphe.net 2 00.0 KB 0 0 000:00:03
4198.235.24.89 1 00.0 KB 0 0 000:00:00
5200.172.132.66.censys-scanner.com 1 00.0 KB 0 0 000:00:09
6o005.scanner.modat.io 1 00.0 KB 0 0 000:00:00
TOTAL: 6 9 00.0 KB 0 0 000:00:35

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

SystemConnArtsSizeGroupsPostRejElapsed
1*.stretchoid.com 4 00.0 KB 0 0 000:00:21
2*.probe.onyphe.net 2 00.0 KB 0 0 000:00:03
3*.66.censys-scanner.com 1 00.0 KB 0 0 000:00:09
4*.scanner.modat.io 1 00.0 KB 0 0 000:00:00
5unresolved 1 00.0 KB 0 0 000:00:00
TOTAL: 5 9 00.0 KB 0 0 000:00:35

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
azpdcgcto85s.stretchoid.com 0.011 0.014 0.00000:00:10
azpdcs5lfrbl.stretchoid.com 0.006 0.020 0.00000:00:10
200.172.132.66.censys-scanner.com 0.035 0.014 0.00000:00:09
marshall.probe.onyphe.net 0.006 0.013 0.00000:00:03
o005.scanner.modat.io 0.006 0.013 0.00000:00:00
198.235.24.89 0.004 0.013 0.00000:00:00
TOTAL: 6 0.068 0.087 0.00000:00:35

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

SystemConn
marshall.probe.onyphe.net 3
200.172.132.66.censys-scanner.com 1
azpdcgcto85s.stretchoid.com 1
azpdcs5lfrbl.stretchoid.com 1
TOTAL: 4 6

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

CommandCount
MGLNDD_172.234.115.63_119 2
#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
W,'? 1
TOTAL: 5 6
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