Daily Usenet report for news.niel.me

Aug 10 04:15:01 -- Aug 11 04:15:01

Unknown entries from news log file:

First 2 / 2 lines (100.0%)

Aug 10 10:43:53 rpi-studio innd: filter: No Cancel-Key[sha1:+F37equZSvZm3eoYApHqIRpQMlM= sha256:XQVsMQmyi1Izg+xlV5DflVIH+tx/ppqvvkWM6/d4rgQ=] matches Cancel-Lock[sha1:JD+BWWHbqDUEq0ehrbS6vxYBAs0= sha256:3nycCquIEm+AWCIwgf9fYDWNunOC+K4vTDkfPXMSKVg=] target=<115c2lj$2vr4a$1@dont-email.me>
Aug 10 16:40:08 rpi-studio innd: filter: No Cancel-Key[sha1:Pb3zqaslwEmRfGL6ifEBzz85WZM= sha256:mM7A3F9jC9Dmw6ICP1hdnrHHnUB1E/gAMfCn0TudoZI=] matches Cancel-Lock[sha1:x+kYnyldUXLEHd+GwkPSuJ2vZQ8= sha256:P2jr86SZsL9KVKrwYMIu40uWDBuJiiMV79IjHYINBWA=] target=<115cnp8$376d5$1@dont-email.me>

Log entries by program:

Program nameLines%LinesSize%Size
inn 2434 29.4%425.6 KB 33.4%
nnrpd 1972 23.9%229.4 KB 18.0%
innd 1952 23.6%344.2 KB 27.0%
innfeed 1908 23.1%274.5 KB 21.6%
controlchan 1 0.0%0.1 KB 0.0%
nocem 1 0.0%0.1 KB 0.0%
TOTAL: 6 8268 100.0%1.2 MB100.0%

History cache:

ReasonCount%Count
Positive hits 8983 51.7%
Negative hits 5992 34.5%
Do not exist 2407 13.8%
Cache misses 1 0.0%
TOTAL: 4 17383 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
artcncl/perl00:00:00.012 0.0%6 0.000 2.000 6.000
article cancel00:00:00.004 0.0%8 0.000 0.500 2.000
article cleanup00:00:00.060 0.0%2413 0.000 0.025 0.200
article logging00:00:00.180 0.0%2413 0.000 0.075 0.333
article parse00:00:00.395 0.0%6036 0.000 0.065 0.333
article write00:00:01.027 0.0%1958 0.000 0.525 2.667
artlog/artcncl00:00:00.001 0.0%8 0.000 0.125 1.000
artlog/artcncl/perl00:00:00.000 0.0%6 0.000 0.000 0.000
data move00:00:00.114 0.0%19733 0.000 0.006 0.029
hisgrep/artcncl00:00:00.000 0.0%8 0.000 0.000 0.000
hisgrep/artcncl/perl00:00:00.001 0.0%6 0.000 0.167 1.000
hisgrep/perl00:00:00.001 0.0%14 0.000 0.071 1.000
hishave/artcncl00:00:00.000 0.0%8 0.000 0.000 0.000
hishave/artcncl/perl00:00:00.000 0.0%6 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:00.290 0.0%17423 0.000 0.017 0.071
history sync00:00:00.055 0.0%353 0.000 0.156 1.000
history write00:00:00.457 0.0%2413 0.000 0.189 0.833
hiswrite/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
idle24:00:29.380100.0%21240 1511.350 4069.180 21429.214
nntp read00:00:00.577 0.0%20530 0.000 0.028 0.080
overview write00:00:00.656 0.0%1958 0.000 0.335 2.000
perl filter00:00:13.289 0.0%2413 1.854 5.507 26.000
python filter00:00:00.009 0.0%2413 0.000 0.004 0.125
site send00:00:00.846 0.0%3958 0.000 0.214 0.667
TOTAL: 24:01:05.67224:00:47.354100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.026 0.0%2013 0.000 0.013 0.250
article prepare00:00:00.000 0.0%36 0.000 0.000 0.000
article read00:00:00.011 0.0%9 0.000 1.222 8.000
backlog stats00:00:00.146 0.0%24446 0.000 0.006 0.027
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:00.330 0.0%12124 0.000 0.027 0.118
data write00:00:00.677 0.0%10341 0.000 0.065 0.137
idle23:58:39.684100.0%24446 1448.087 3531.035 9098.939
status file00:00:07.092 0.0%306 1.000 23.176 81.000
TOTAL: 23:58:57.19323:58:47.966100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:45.689 51.1%1485 10.400 30.767 10017.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.107 0.1%3379 0.000 0.032 0.273
TOTAL: 00:01:29.46600:00:45.796 51.2%----

Control commands to INND:

CommandNumber
flush 5
flushlogs 2
go 2
logmode 2
lowmark 1
mode 149
name 2
pause 2
paused 2
reload 2
reserve 2
TOTAL: 11 171

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1feed-out.gegeweb.org 3 1947 804 1143 0 41%23:59:29
2news.nntp4.net 2 2316 501 1469 346 21%23:10:40
3news.samoylyk.net 1 1042 196 842 4 18%13:02:57
4nntp.terraraq.uk 2 1496 76 1416 4 5%26:37:12
5gegeweb-out.news.tnetconsulting.net 2 2421 43 2377 1 1%39:48:49
6usenet.pasdenom.info 12 904 40 861 3 4%23:25:56
7news.glou.org 2 155 21 124 10 13%04:40:52
8localhost 25 0 0 0 0 0%00:00:00
TOTAL: 8 49 10281 1681 8232 368 16%154:45:55
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1feed-out.gegeweb.org2.6 MB0.0 KB0.0 KB2.6 MB100%3.3 KB
2news.nntp4.net2.3 MB0.0 KB3.0 MB5.3 MB 43%6.5 KB
3news.samoylyk.net940.6 KB0.0 KB5.7 KB946.3 KB 99%4.7 KB
4nntp.terraraq.uk189.0 KB0.0 KB8.9 KB197.9 KB 95%2.5 KB
5gegeweb-out.news.tnetconsulting.net138.9 KB0.0 KB1.8 KB140.7 KB 98%3.2 KB
6usenet.pasdenom.info97.0 KB0.0 KB3.7 KB100.6 KB 96%2.3 KB
7news.glou.org81.4 KB0.0 KB31.5 KB112.9 KB 72%3.6 KB
8localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 86.3 MB0.0 KB3.1 MB9.4 MB 67%4.7 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Aug 10 04:15:01 - 04:59:59 31 1.6% 0.01210.2 KB 2.7% 0.08
Aug 10 05:00:00 - 05:59:59 54 2.7% 0.01170.9 KB 2.2% 0.05
Aug 10 06:00:00 - 06:59:59 34 1.7% 0.01128.2 KB 1.7% 0.04
Aug 10 07:00:00 - 07:59:59 46 2.3% 0.01119.4 KB 1.5% 0.03
Aug 10 08:00:00 - 08:59:59 41 2.1% 0.01133.8 KB 1.7% 0.04
Aug 10 09:00:00 - 09:59:59 71 3.6% 0.02286.6 KB 3.7% 0.08
Aug 10 10:00:00 - 10:59:59 68 3.5% 0.02218.9 KB 2.8% 0.06
Aug 10 11:00:00 - 11:59:59 90 4.6% 0.03367.2 KB 4.8% 0.10
Aug 10 12:00:00 - 12:59:59 76 3.9% 0.02331.9 KB 4.3% 0.09
Aug 10 13:00:00 - 13:59:59 73 3.7% 0.02255.1 KB 3.3% 0.07
Aug 10 14:00:00 - 14:59:59 90 4.6% 0.03388.7 KB 5.0% 0.11
Aug 10 15:00:00 - 15:59:59 151 7.7% 0.04759.7 KB 9.8% 0.21
Aug 10 16:00:00 - 16:59:59 135 6.9% 0.04452.8 KB 5.9% 0.13
Aug 10 17:00:00 - 17:59:59 137 7.0% 0.04649.0 KB 8.4% 0.18
Aug 10 18:00:00 - 18:59:59 129 6.6% 0.04647.7 KB 8.4% 0.18
Aug 10 19:00:00 - 19:59:59 125 6.4% 0.03372.1 KB 4.8% 0.10
Aug 10 20:00:00 - 20:59:59 112 5.7% 0.03409.4 KB 5.3% 0.11
Aug 10 21:00:00 - 21:59:59 85 4.3% 0.02292.1 KB 3.8% 0.08
Aug 10 22:00:00 - 22:59:59 109 5.5% 0.03437.8 KB 5.7% 0.12
Aug 10 23:00:00 - 23:59:59 81 4.1% 0.02245.4 KB 3.2% 0.07
Aug 11 00:00:00 - 00:59:59 79 4.0% 0.02302.8 KB 3.9% 0.08
Aug 11 01:00:00 - 01:59:59 47 2.4% 0.01201.3 KB 2.6% 0.06
Aug 11 02:00:00 - 02:59:59 55 2.8% 0.02205.4 KB 2.7% 0.06
Aug 11 03:00:00 - 03:59:59 30 1.5% 0.0194.5 KB 1.2% 0.03
Aug 11 04:00:00 - 04:15:01 15 0.8% 0.0236.7 KB 0.5% 0.04
TOTAL: 24:00:00 1964 100.0% 0.027.5 MB 100.0% 0.09
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1news.nntp4.net 416 312 0 0 0 0 0 0 104
2news.glou.org 32 0 0 0 0 0 0 0 32
3news.samoylyk.net 4 0 0 0 0 0 0 0 4
4usenet.pasdenom.info 3 0 0 0 0 0 0 0 3
5nntp.terraraq.uk 1 0 0 0 0 0 0 0 1
TOTAL: 5 456 312 0 0 0 0 0 0 144

Unwanted newsgroups [Top 20]:

NewsgroupCount
linux.kernel.netdev 272
linux.kernel.git 40
TOTAL: 2 312

INND Perl filter [Top 20]:

ReasonCount
Too many newsgroups 95
Bad path (news.giganews.com.POSTED) 37
Cancels abusifs 4
Cancel of non-existing ID <115c2lj$2vr4a$1@dont-email.me> 2
EMP (phn path) 2
Cancel of non-existing ID <115cnp8$376d5$1@dont-email.me> 2
Cancel of <115bn74$2sg3g$2@dont-email.me> without Cancel-Key 1
Cancel of <115bnka$2sk6r$1@dont-email.me> without Cancel-Key 1
TOTAL: 8 144

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1nntp.terraraq.uk 990 1 949 0 0 0 0%23:39:07
2news.gegeweb.org 1271 1 1166 0 0 0 0%23:54:11
3news.samoylyk.net 1982 0 1559 6 0 22 0%23:55:38
4news.pasdenom.info 1400 0 1362 0 0 4 0%23:54:53
5news.nntp4.net 1486 0 1434 0 0 0 0%23:44:10
6news.tnetconsulting.net 3383 0 1962 1 0 23 0%23:57:18
7news.aioe.org 0 0 0 0 0 1678 0%24:00:00
8i2pn.org 0 0 0 0 0 1958 0%24:00:00
TOTAL: 8 10512 2 8432 7 0 3685 0%191:05:17
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.gegeweb.org3.8 KB0.0 KB3.8 KB0.0 KB/s3.8 KB23:54:11
2nntp.terraraq.uk2.0 KB0.0 KB2.0 KB0.0 KB/s2.0 KB23:39:07
3news.samoylyk.net0.0 KB20.7 KB20.7 KB0.0 KB/s3.4 KB23:55:38
4news.pasdenom.info0.0 KB0.0 KB0.0 KB0.0 KB/s023:54:53
5news.nntp4.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:44:10
6news.tnetconsulting.net0.0 KB13.1 KB13.1 KB0.0 KB/s13.1 KB23:57:18
7news.aioe.org0.0 KB0.0 KB0.0 KB0.0 KB/s024:00:00
8i2pn.org0.0 KB0.0 KB0.0 KB0.0 KB/s024:00:00
TOTAL: 85.9 KB33.8 KB39.7 KB0.0 KB/s4.4 KB191:05:17
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
145-56-79-53.ip.linodeusercontent.com 1 00.0 KB 0 0 000:00:00
2r5-46-2e.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
3mail.gegeweb.eu 288 00.0 KB 0 0 000:00:25
445-79-207-110.ip.linodeusercontent.com 1 00.0 KB 0 0 000:00:00
5r3-183-b7.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
666.61.98.95 2 00.0 KB 0 0 000:00:04
7r3-51-33.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
8147.185.133.18 2 00.0 KB 0 0 000:00:29
9198.235.24.245 1 00.0 KB 0 0 000:00:01
10r5-43-2b.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
11154.210.203.35.bc.googleusercontent.com 1 00.0 KB 0 0 000:00:00
12r3-114-72.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:01
13r5-55-37.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
1493.123.109.30 1 00.0 KB 0 0 000:00:07
1569.5.169.20 1 00.0 KB 0 0 000:00:00
16r5-54-36.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
1769.5.169.145 1 00.0 KB 0 0 000:00:00
18r5-45-2d.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
19r5-42-2a.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:01
20r5-40-28.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
21azpdwsts63ek.stretchoid.com 2 00.0 KB 0 0 000:00:10
22r4-18-12.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:03
23193.172.132.66.censys-scanner.com 1 00.0 KB 0 0 000:00:00
24r5-15-f.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:03
25r5-182-b6.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
26lisbon.scan.bufferover.run 2 00.0 KB 0 0 000:00:02
27r3-55-37.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:01
28r4-60-3c.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:01
29r4-46-2e.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
30r3-69-45.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:01
312603:6010:6802:4ca5:1a03:73ff:fe28:be0f 2 00.0 KB 0 0 000:00:05
32r5-72-48.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
33r5-64-40.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
34r3-208-d0.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
35r4-57-39.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
3686.54.31.34 1 00.0 KB 0 0 000:00:00
TOTAL: 36 328 00.0 KB 0 0 000:01:45

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.monitoring.internet-measurement.com 21 00.0 KB 0 0 000:00:16
2*.ip.linodeusercontent.com 2 00.0 KB 0 0 000:00:01
3*.210.203.35.bc.googleusercontent.com 1 00.0 KB 0 0 000:00:00
4unresolved 9 00.0 KB 0 0 000:00:43
5? 2 00.0 KB 0 0 000:00:05
6*.scan.bufferover.run 2 00.0 KB 0 0 000:00:02
7*.gegeweb.eu 288 00.0 KB 0 0 000:00:25
8*.stretchoid.com 2 00.0 KB 0 0 000:00:10
9*.172.132.66.censys-scanner.com 1 00.0 KB 0 0 000:00:00
TOTAL: 9 328 00.0 KB 0 0 000:01:45

NNRP auth users [Top 20]:

UserConn
mailman 288
TOTAL: 1 288

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
147.185.133.18 0.310 0.068 0.00000:00:29
mail.gegeweb.eu 5.146 4.678 1.77800:00:25
azpdwsts63ek.stretchoid.com 0.043 0.035 0.00000:00:10
93.123.109.30 0.024 0.000 0.00000:00:07
2603:6010:6802:4ca5:1a03:73ff:fe28:be0f 0.063 0.055 0.00000:00:05
66.61.98.95 0.078 0.035 0.00000:00:04
r5-15-f.monitoring.internet-measurement.com 0.041 0.021 0.00000:00:03
r4-18-12.monitoring.internet-measurement.com 0.072 0.008 0.00000:00:03
lisbon.scan.bufferover.run 0.047 0.047 0.00000:00:02
r3-114-72.monitoring.internet-measurement.com 0.033 0.020 0.00000:00:01
198.235.24.245 0.030 0.021 0.00000:00:01
r3-55-37.monitoring.internet-measurement.com 0.072 0.022 0.00000:00:01
r5-42-2a.monitoring.internet-measurement.com 0.070 0.024 0.00000:00:01
r3-69-45.monitoring.internet-measurement.com 0.078 0.016 0.00000:00:01
r4-60-3c.monitoring.internet-measurement.com 0.072 0.024 0.00000:00:01
45-79-207-110.ip.linodeusercontent.com 0.032 0.016 0.00000:00:00
193.172.132.66.censys-scanner.com 0.033 0.025 0.00000:00:00
154.210.203.35.bc.googleusercontent.com 0.074 0.019 0.00000:00:00
r5-43-2b.monitoring.internet-measurement.com 0.042 0.005 0.00000:00:00
r5-55-37.monitoring.internet-measurement.com 0.036 0.012 0.00000:00:00
TOTAL: 33 6.790 5.314 1.77800:01:45

NNRP gethostbyaddr failures [Top 20]:

SystemConn
? (can't getpeername) 10
TOTAL: 1 10

NNRP unrecognized commands (by host):

SystemConn
lisbon.scan.bufferover.run 11
147.185.133.18 4
154.210.203.35.bc.googleusercontent.com 4
93.123.109.30 2
193.172.132.66.censys-scanner.com 1
azpdwsts63ek.stretchoid.com 1
TOTAL: 6 23

NNRP unrecognized commands (by command):

CommandCount
#001 3
#026#003#001#001 2
GET / HTTP/1.1 2
À$À(À#À' 2
Host: 45.13.105.36:563 2
À#024 2
Accept-Encoding: gzip 1
Accept: */* 1
User-Agent: curl/7.68.0 1
#026#003#001 1
4l™<#002QZµ0 1
User-Agent: Hello from Palo Alto Network... 1
]Z;÷.‰à#0277L#022í#017Œ5 1
EHLO www.censys.io 1
ú©“á 1
MGLNDD_45.13.105.36_119 1
TOTAL: 16 23

NNRP client timeouts [Top 20]:

SystemConnPeer
147.185.133.18 1 2
69.5.169.20 1 1
TOTAL: 2 2 7