Daily Usenet report

Aug 25 03:00:03 -- Aug 26 03:00:02

Unknown entries from news log file:

First 50 / 100 lines (50.0%)

Aug 25 03:00:56 twilightnode innd: message repeated 2 times: [ ctlinnd command s]
Aug 25 10:50:19 twilightnode nnrpd[2106168]: Reading access from /usr/local/news/etc/readers.conf
Aug 25 10:50:19 twilightnode nnrpd[2106168]: Auth strategy 'localhost' does not match client. Removing.
Aug 25 10:50:19 twilightnode nnrpd[2106168]: 56.154.45.199.censys-scanner.com res <anonymous>
Aug 25 10:50:19 twilightnode nnrpd[2106168]: 56.154.45.199.censys-scanner.com no_match_user <anonymous> <localhost>
Aug 25 10:50:19 twilightnode nnrpd[2106168]: 56.154.45.199.censys-scanner.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Aug 25 10:50:19 twilightnode nnrpd[2106168]: 56.154.45.199.censys-scanner.com match_user <anonymous> <anonymous>
Aug 25 10:50:19 twilightnode nnrpd[2106168]: 56.154.45.199.censys-scanner.com no_post anonymous-read
Aug 25 10:50:24 twilightnode nnrpd[2106169]: Reading access from /usr/local/news/etc/readers.conf
Aug 25 10:50:24 twilightnode nnrpd[2106169]: Auth strategy 'localhost' does not match client. Removing.
Aug 25 10:50:24 twilightnode nnrpd[2106169]: 56.154.45.199.censys-scanner.com res <anonymous>
Aug 25 10:50:24 twilightnode nnrpd[2106169]: 56.154.45.199.censys-scanner.com no_match_user <anonymous> <localhost>
Aug 25 10:50:24 twilightnode nnrpd[2106169]: 56.154.45.199.censys-scanner.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Aug 25 10:50:24 twilightnode nnrpd[2106169]: 56.154.45.199.censys-scanner.com match_user <anonymous> <anonymous>
Aug 25 10:50:24 twilightnode nnrpd[2106169]: 56.154.45.199.censys-scanner.com no_post anonymous-read
Aug 25 10:50:27 twilightnode nnrpd[2106172]: Reading access from /usr/local/news/etc/readers.conf
Aug 25 10:50:27 twilightnode nnrpd[2106172]: Auth strategy 'localhost' does not match client. Removing.
Aug 25 10:50:27 twilightnode nnrpd[2106172]: 56.154.45.199.censys-scanner.com res <anonymous>
Aug 25 10:50:27 twilightnode nnrpd[2106172]: 56.154.45.199.censys-scanner.com no_match_user <anonymous> <localhost>
Aug 25 10:50:27 twilightnode nnrpd[2106172]: 56.154.45.199.censys-scanner.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Aug 25 10:50:27 twilightnode nnrpd[2106172]: 56.154.45.199.censys-scanner.com match_user <anonymous> <anonymous>
Aug 25 10:50:27 twilightnode nnrpd[2106172]: 56.154.45.199.censys-scanner.com no_post anonymous-read
Aug 25 10:50:28 twilightnode nnrpd[2106172]: 56.154.45.199.censys-scanner.com res <anonymous>
Aug 25 10:50:28 twilightnode nnrpd[2106172]: 56.154.45.199.censys-scanner.com no_match_user <anonymous> <localhost>
Aug 25 10:50:28 twilightnode nnrpd[2106172]: 56.154.45.199.censys-scanner.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Aug 25 10:50:28 twilightnode nnrpd[2106172]: 56.154.45.199.censys-scanner.com match_user <anonymous> <anonymous>
Aug 25 10:50:28 twilightnode nnrpd[2106172]: 56.154.45.199.censys-scanner.com no_post anonymous-read
Aug 25 13:28:24 twilightnode nnrpd[2113022]: Reading access from /usr/local/news/etc/readers.conf
Aug 25 13:28:24 twilightnode nnrpd[2113022]: Auth strategy 'localhost' does not match client. Removing.
Aug 25 13:28:24 twilightnode nnrpd[2113022]: 48.146.94.167.censys-scanner.com res <anonymous>
Aug 25 13:28:24 twilightnode nnrpd[2113022]: 48.146.94.167.censys-scanner.com no_match_user <anonymous> <localhost>
Aug 25 13:28:24 twilightnode nnrpd[2113022]: 48.146.94.167.censys-scanner.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Aug 25 13:28:24 twilightnode nnrpd[2113022]: 48.146.94.167.censys-scanner.com match_user <anonymous> <anonymous>
Aug 25 13:28:24 twilightnode nnrpd[2113022]: 48.146.94.167.censys-scanner.com no_post anonymous-read
Aug 25 13:28:28 twilightnode nnrpd[2113023]: Reading access from /usr/local/news/etc/readers.conf
Aug 25 13:28:28 twilightnode nnrpd[2113023]: Auth strategy 'localhost' does not match client. Removing.
Aug 25 13:28:28 twilightnode nnrpd[2113023]: 48.146.94.167.censys-scanner.com res <anonymous>
Aug 25 13:28:28 twilightnode nnrpd[2113023]: 48.146.94.167.censys-scanner.com no_match_user <anonymous> <localhost>
Aug 25 13:28:28 twilightnode nnrpd[2113023]: 48.146.94.167.censys-scanner.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Aug 25 13:28:28 twilightnode nnrpd[2113023]: 48.146.94.167.censys-scanner.com match_user <anonymous> <anonymous>
Aug 25 13:28:28 twilightnode nnrpd[2113023]: 48.146.94.167.censys-scanner.com no_post anonymous-read
Aug 25 13:28:32 twilightnode nnrpd[2113026]: Reading access from /usr/local/news/etc/readers.conf
Aug 25 13:28:32 twilightnode nnrpd[2113026]: Auth strategy 'localhost' does not match client. Removing.
Aug 25 13:28:32 twilightnode nnrpd[2113026]: 48.146.94.167.censys-scanner.com res <anonymous>
Aug 25 13:28:32 twilightnode nnrpd[2113026]: 48.146.94.167.censys-scanner.com no_match_user <anonymous> <localhost>
Aug 25 13:28:32 twilightnode nnrpd[2113026]: 48.146.94.167.censys-scanner.com no_match_user <anonymous> *,!<anonymous>,!<localhost>
Aug 25 13:28:32 twilightnode nnrpd[2113026]: 48.146.94.167.censys-scanner.com match_user <anonymous> <anonymous>
Aug 25 13:28:32 twilightnode nnrpd[2113026]: 48.146.94.167.censys-scanner.com no_post anonymous-read
Aug 25 13:28:32 twilightnode nnrpd[2113026]: 48.146.94.167.censys-scanner.com res <anonymous>
Aug 25 13:28:32 twilightnode nnrpd[2113026]: 48.146.94.167.censys-scanner.com no_match_user <anonymous> <localhost>

Log entries by program:

Program nameLines%LinesSize%Size
inn 6886 53.0%1.2 MB 58.4%
innd 4694 36.1%658.2 KB 31.6%
innfeed 1254 9.7%191.1 KB 9.2%
nnrpd 154 1.2%16.4 KB 0.8%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 5 12989 100.0%2.0 MB100.0%

History cache:

ReasonCount%Count
Positive hits 18621 52.7%
Negative hits 9882 28.0%
Do not exist 6840 19.4%
Cache misses 5 0.0%
TOTAL: 4 35348 100.0%

innd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.030 0.0%12 0.571 2.500 11.000
article cleanup00:00:00.063 0.0%6861 0.000 0.009 0.095
article logging00:00:00.176 0.0%6889 0.000 0.026 0.136
article parse00:00:00.109 0.0%9179 0.000 0.012 0.080
article write00:00:04.451 0.0%5595 0.355 0.796 2.467
artlog/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
data move00:00:00.080 0.0%36953 0.000 0.002 0.026
hisgrep/artcncl00:00:00.006 0.0%12 0.000 0.500 1.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:02.879 0.0%35461 0.028 0.081 0.190
history sync00:00:00.039 0.0%408 0.000 0.096 1.000
history write00:00:02.430 0.0%6861 0.100 0.354 0.808
idle24:00:36.680100.0%38248 1117.073 2259.901 8959.612
nntp read00:00:00.615 0.0%37187 0.000 0.017 0.053
overview write00:00:02.665 0.0%5595 0.105 0.476 1.667
perl filter00:00:09.088 0.0%6861 0.651 1.325 8.955
python filter00:00:00.506 0.0%6861 0.000 0.074 0.727
site send00:00:00.219 0.0%11158 0.000 0.020 0.095
TOTAL: 1824:01:00.036100.0%----

innfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.022 0.0%5958 0.000 0.004 0.100
article prepare00:00:00.002 0.0%25536 0.000 0.000 0.008
article read00:00:00.793 0.0%3868 0.000 0.205 2.000
backlog stats00:00:00.041 0.0%74842 0.000 0.001 0.005
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:00.504 0.0%41692 0.000 0.012 0.046
data write00:00:00.822 0.0%36313 0.000 0.023 0.085
idle23:49:53.638100.0%74842 345.807 1146.330 4847.773
status file00:00:00.072 0.0%161 0.000 0.447 2.000
TOTAL: 923:49:55.894100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:33.207100.0%20 72.500 1660.350 11329.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.001 0.0%135 0.000 0.007 0.500
TOTAL: 300:00:33.208100.0%----

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 (innd):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1twilightnode-out.news.weretis.net 4 10005 4204 5603 198 42%44:26:20
2usenet.blueworldhosting.com 714 6755 970 4912 873 14%23:47:02
3newsfeed.endofthelinebbs.com 1 4546 175 4273 98 3%23:25:10
4news.sklaffkom.se 38 71 68 3 0 95%08:46:35
5news.tebibyte.org 2 460 59 401 0 12%06:36:50
6localhost 25 0 0 0 0 0%00:00:00
TOTAL: 6 784 21837 5476 15192 1169 25%107:01:57
Articles received by server

Incoming volume (innd):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1twilightnode-out.news.weretis.net13.5 MB0.0 KB639.0 KB14.1 MB 95%3.3 KB
2usenet.blueworldhosting.com4.0 MB0.0 KB1.4 MB5.5 MB 73%3.0 KB
3newsfeed.endofthelinebbs.com1.9 MB0.0 KB175.9 KB2.1 MB 91%7.9 KB
4news.sklaffkom.se181.7 KB0.0 KB0.0 KB181.7 KB100%2.7 KB
5news.tebibyte.org168.3 KB0.0 KB0.0 KB168.3 KB100%2.9 KB
6localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 619.8 MB0.0 KB2.2 MB22.0 MB 89%3.4 KB
Incoming volume received by server

Incoming articles (innd):

DateArticles%ArtsArt/secSize%SizeKB/sec
Aug 25 03:00:03 - 03:59:59 113 2.0% 0.03525.3 KB 2.6% 0.15
Aug 25 04:00:00 - 04:59:59 98 1.8% 0.03470.2 KB 2.3% 0.13
Aug 25 05:00:00 - 05:59:59 83 1.5% 0.02287.1 KB 1.4% 0.08
Aug 25 06:00:00 - 06:59:59 106 1.9% 0.03350.2 KB 1.7% 0.10
Aug 25 07:00:00 - 07:59:59 120 2.1% 0.03456.6 KB 2.3% 0.13
Aug 25 08:00:00 - 08:59:59 223 4.0% 0.06692.6 KB 3.4% 0.19
Aug 25 09:00:00 - 09:59:59 245 4.4% 0.07815.2 KB 4.1% 0.23
Aug 25 10:00:00 - 10:59:59 272 4.9% 0.081.0 MB 5.2% 0.29
Aug 25 11:00:00 - 11:59:59 272 4.9% 0.08873.7 KB 4.3% 0.24
Aug 25 12:00:00 - 12:59:59 268 4.8% 0.071004.1 KB 5.0% 0.28
Aug 25 13:00:00 - 13:59:59 309 5.5% 0.09915.4 KB 4.5% 0.25
Aug 25 14:00:00 - 14:59:59 315 5.6% 0.091.1 MB 5.6% 0.31
Aug 25 15:00:00 - 15:59:59 269 4.8% 0.07895.9 KB 4.5% 0.25
Aug 25 16:00:00 - 16:59:59 269 4.8% 0.07911.9 KB 4.5% 0.25
Aug 25 17:00:00 - 17:59:59 352 6.3% 0.101.1 MB 5.8% 0.32
Aug 25 18:00:00 - 18:59:59 299 5.3% 0.081.1 MB 5.4% 0.30
Aug 25 19:00:00 - 19:59:59 311 5.6% 0.091.0 MB 5.3% 0.30
Aug 25 20:00:00 - 20:59:59 295 5.3% 0.081.1 MB 5.7% 0.32
Aug 25 21:00:00 - 21:59:59 299 5.3% 0.081.1 MB 5.9% 0.33
Aug 25 22:00:00 - 22:59:59 257 4.6% 0.07991.0 KB 4.9% 0.28
Aug 25 23:00:00 - 23:59:59 333 6.0% 0.091.2 MB 6.3% 0.35
Aug 26 00:00:00 - 00:59:59 241 4.3% 0.07919.8 KB 4.6% 0.26
Aug 26 01:00:00 - 01:59:59 138 2.5% 0.04540.8 KB 2.7% 0.15
Aug 26 02:00:00 - 02:59:59 98 1.8% 0.03358.3 KB 1.8% 0.10
Aug 26 03:00:00 - 03:00:02 8 0.1% 4.0010.5 KB 0.1% 5.26
TOTAL: 23:59:59 5593 100.0% 0.0619.7 MB 100.0% 0.23
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1usenet.blueworldhosting.com 873 351 0 0 1 0 0 0 521
2twilightnode-out.news.weretis.net 284 5 0 0 0 0 0 0 279
3newsfeed.endofthelinebbs.com 95 10 0 0 0 0 0 0 85
4news.tebibyte.org 41 0 0 0 0 0 0 0 41
TOTAL: 4 1293 366 0 0 1 0 0 0 926

Unwanted newsgroups [Top 20]:

NewsgroupCount
alt.test.ping 288
hispagatos.hacking.ransomware 27
fido.pushkin.local 8
newsgrouper.support 7
fido.su.pol 5
hispagatos.mastodon.tag.hacking 4
alt.managing.techsupport 3
wolfsburg.test 3
alt.algerie.test 2
alt.sex.pedophilia 2
fido.pvt.zona 2
fido.su.formula1 2
S.E.D 1
alt.2600.madrid 1
alt.asshole.binky 1
alt.bbs.files-announce 1
alt.nl.test 1
alt.politics.socialist.nazi 1
chmurka.statystyki 1
fido.r50.sysop.drunk 1
TOTAL: 25 366

Supposedly-moderated groups with unmoderated postings [Top 20]:

GroupsCount
uk.religion.christian 1
TOTAL: 1 1

Perl filter (innd) [Top 20]:

ReasonCount
EMP (md5) 493
EMP (phn path) 258
Too many newsgroups 61
Binary: misplaced binary 41
Too many newsgroups (meow) 17
User-issued cancel 13
EMP (phl) 9
Too many test groups in crosspost 5
HTML Multipart 1
TOTAL: 9 898

Miscellaneous innd statistics [Top 10]:

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

Outgoing feeds (innfeed) by articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.tebibyte.org 7053 2561 2817 64 118 33 36%23:59:54
2sklaffkom.se 5736 848 1863 2726 123 42 14%23:59:56
3newsfeed.endofthelinebbs.com 10042 43 5295 19 5 291 0%23:58:43
4usenet.blueworldhosting.com 7254 7 4238 0 0 54 0%23:59:56
5weretis.net 1414 5 1336 0 0 0 0%23:50:32
TOTAL: 5 31499 3464 15549 2809 246 420 10%119:49:01
Outgoing feeds (innfeed) by articles

Outgoing feeds (innfeed) by volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.tebibyte.org7.4 MB302.3 KB7.7 MB0.1 KB/s3.0 KB23:59:54
2sklaffkom.se1.4 MB11.0 MB12.4 MB0.1 KB/s3.5 KB23:59:56
3newsfeed.endofthelinebbs.com140.9 KB65.8 KB206.6 KB0.0 KB/s3.3 KB23:58:43
4usenet.blueworldhosting.com30.4 KB0.0 KB30.4 KB0.0 KB/s4.3 KB23:59:56
5weretis.net8.5 KB0.0 KB8.5 KB0.0 KB/s1.7 KB23:50:32
TOTAL: 59.0 MB11.3 MB20.3 MB0.0 KB/s3.3 KB119:49:01
Outgoing feeds (innfeed) by volume

NNRP readership statistics [Top 100]:

SystemConnArtsSizeGroupsPostRejElapsed
1152.32.180.86 3 00.0 KB 0 0 000:00:17
248.146.94.167.censys-scanner.com 3 00.0 KB 0 0 000:00:01
356.154.45.199.censys-scanner.com 3 00.0 KB 0 0 000:00:02
4azpdcs7c64su.stretchoid.com 2 00.0 KB 0 0 000:00:10
5141.172.132.66.censys-scanner.com 1 00.0 KB 0 0 000:00:00
TOTAL: 5 12 00.0 KB 0 0 000:00:33

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

SystemConnArtsSizeGroupsPostRejElapsed
1*.167.censys-scanner.com 3 00.0 KB 0 0 000:00:01
2*.199.censys-scanner.com 3 00.0 KB 0 0 000:00:02
3unresolved 3 00.0 KB 0 0 000:00:17
4*.stretchoid.com 2 00.0 KB 0 0 000:00:10
5*.66.censys-scanner.com 1 00.0 KB 0 0 000:00:00
TOTAL: 5 12 00.0 KB 0 0 000:00:33

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
152.32.180.86 0.013 0.028 0.00000:00:17
azpdcs7c64su.stretchoid.com 0.010 0.007 0.00000:00:10
56.154.45.199.censys-scanner.com 0.040 0.021 0.00000:00:02
48.146.94.167.censys-scanner.com 0.031 0.031 0.00000:00:01
141.172.132.66.censys-scanner.com 0.034 0.006 0.00000:00:00
TOTAL: 5 0.128 0.093 0.00000:00:33

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

SystemConn
152.32.180.86 2
141.172.132.66.censys-scanner.com 1
48.146.94.167.censys-scanner.com 1
56.154.45.199.censys-scanner.com 1
azpdcs7c64su.stretchoid.com 1
TOTAL: 5 6

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

CommandCount
EHLO www.censys.io 3
#026#003#001 1
?#024 1
MGLNDD_172.234.115.63_119 1
TOTAL: 4 6

NNRP client timeouts [Top 20]:

SystemConnPeer
48.146.94.167.censys-scanner.com 1 2
56.154.45.199.censys-scanner.com 1 2
TOTAL: 2 2 4
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