Daily Usenet report for news.niel.me

Apr 20 04:15:01 -- Apr 21 04:15:02

Unknown entries from news log file:

First 2 / 2 lines (100.0%)

Apr 20 13:48:30 rpi-studio innd: filter: No Cancel-Key[sha1:/A27cW+CQsixC1H8btIfS+oo+T8=] matches Cancel-Lock[sha1:1gtIyNHUH1MwadHJiWs7mTPJ+44=] target=<6804de64$0$29712$426a34cc@news.free.fr>
Apr 20 17:39:54 rpi-studio innd: filter: No Cancel-Key[sha1:NLF+iKPULFh+OepPFfp262fxfwM=] matches Cancel-Lock[sha1:WW6Dhto/aUrSywB5UozmwXjQeyY=] target=<680514a0$0$28077$426a74cc@news.free.fr>

Log entries by program:

Program nameLines%LinesSize%Size
innd 2154 26.5%372.5 KB 29.6%
nnrpd 2143 26.4%251.3 KB 19.9%
innfeed 1941 23.9%295.9 KB 23.5%
inn 1880 23.2%339.7 KB 27.0%
controlchan 1 0.0%0.1 KB 0.0%
nocem 1 0.0%0.2 KB 0.0%
TOTAL: 6 8120 100.0%1.2 MB100.0%

History cache:

ReasonCount%Count
Positive hits 9302 57.4%
Negative hits 5038 31.1%
Do not exist 1859 11.5%
Cache misses 4 0.0%
TOTAL: 4 16203 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
artcncl/perl00:00:00.007 0.0%5 0.000 1.400 5.000
article cancel00:00:00.001 0.0%5 0.000 0.200 1.000
article cleanup00:00:00.042 0.0%1862 0.000 0.023 0.200
article logging00:00:00.127 0.0%1862 0.000 0.068 0.500
article parse00:00:00.245 0.0%4085 0.000 0.060 0.273
article write00:00:00.906 0.0%1679 0.000 0.540 1.333
artlog/artcncl00:00:00.000 0.0%5 0.000 0.000 0.000
artlog/artcncl/perl00:00:00.000 0.0%5 0.000 0.000 0.000
data move00:00:00.090 0.0%16794 0.000 0.005 0.051
hisgrep/artcncl00:00:00.000 0.0%5 0.000 0.000 0.000
hisgrep/artcncl/perl00:00:00.000 0.0%5 0.000 0.000 0.000
hisgrep/perl00:00:00.000 0.0%8 0.000 0.000 0.000
hishave/artcncl00:00:00.001 0.0%5 0.000 0.200 1.000
hishave/artcncl/perl00:00:00.000 0.0%5 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:00.283 0.0%16212 0.000 0.017 0.059
history sync00:00:00.043 0.0%338 0.000 0.127 1.000
history write00:00:00.319 0.0%1862 0.000 0.171 1.000
hiswrite/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
idle24:00:43.149100.0%18891 1388.891 4575.891 42863.571
nntp read00:00:00.499 0.0%18022 0.000 0.028 0.128
overview write00:00:00.527 0.0%1679 0.000 0.314 3.500
perl filter00:00:08.869 0.0%1862 1.250 4.763 22.600
python filter00:00:00.010 0.0%1862 0.000 0.005 0.143
site send00:00:00.529 0.0%3389 0.000 0.156 0.667
TOTAL: 24:01:03.17524:00:55.647100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.016 0.0%1890 0.000 0.008 0.143
article prepare00:00:00.000 0.0%332 0.000 0.000 0.000
article read00:00:00.018 0.0%82 0.000 0.220 8.000
backlog stats00:00:00.136 0.0%25159 0.000 0.005 0.031
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:00.395 0.0%12621 0.000 0.031 0.083
data write00:00:00.586 0.0%11031 0.000 0.053 0.167
idle23:49:51.259100.0%25159 879.345 3409.963 9113.894
status file00:00:05.623 0.0%324 0.667 17.355 86.000
TOTAL: 23:50:02.25423:49:58.033100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:36.200 8.6%1564 0.000 23.146 2347.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.135 0.0%3600 0.000 0.037 1.000
readart00:00:00.000 0.0%8 0.000 0.000 0.000
TOTAL: 00:07:00.92900:00:36.335 8.6%----

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
1news.nntp4.net 2 1925 577 1177 171 29%26:03:36
2feed-out.gegeweb.org 4 1659 464 1195 0 27%23:57:44
3news.samoylyk.net 4 2153 336 1817 0 15%29:30:40
4nntp.terraraq.uk 9 2123 249 1864 10 11%45:25:51
5i2pn.org 3 1793 111 1681 1 6%26:19:57
6news.glou.org 3 1259 95 1150 14 7%23:52:47
7gegeweb-out.news.tnetconsulting.net 6 1244 63 1179 2 5%25:47:50
8localhost 25 0 0 0 0 0%00:00:00
9usenet.pasdenom.info 11 787 0 787 0 0%23:30:30
TOTAL: 9 67 12943 1895 10850 198 14%224:28:55
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1news.nntp4.net2.2 MB0.0 KB752.4 KB3.0 MB 75%4.1 KB
2news.samoylyk.net1.9 MB0.0 KB0.0 KB1.9 MB100%5.8 KB
3feed-out.gegeweb.org1.4 MB0.0 KB0.0 KB1.4 MB100%3.1 KB
4nntp.terraraq.uk494.6 KB0.0 KB39.1 KB533.7 KB 92%2.1 KB
5news.glou.org352.1 KB0.0 KB68.9 KB421.0 KB 83%3.9 KB
6gegeweb-out.news.tnetconsulting.net287.1 KB0.0 KB8.1 KB295.2 KB 97%4.5 KB
7i2pn.org253.1 KB0.0 KB1.8 KB254.9 KB 99%2.3 KB
8localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
9usenet.pasdenom.info0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 96.9 MB0.0 KB870.4 KB7.8 MB 89%3.8 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Apr 20 04:15:01 - 04:59:59 25 1.5% 0.0179.8 KB 1.3% 0.03
Apr 20 05:00:00 - 05:59:59 52 3.1% 0.01219.7 KB 3.4% 0.06
Apr 20 06:00:00 - 06:59:59 40 2.4% 0.01103.0 KB 1.6% 0.03
Apr 20 07:00:00 - 07:59:59 31 1.8% 0.01195.2 KB 3.1% 0.05
Apr 20 08:00:00 - 08:59:59 28 1.7% 0.0164.3 KB 1.0% 0.02
Apr 20 09:00:00 - 09:59:59 49 2.9% 0.01182.6 KB 2.9% 0.05
Apr 20 10:00:00 - 10:59:59 38 2.3% 0.01132.6 KB 2.1% 0.04
Apr 20 11:00:00 - 11:59:59 36 2.1% 0.01182.3 KB 2.9% 0.05
Apr 20 12:00:00 - 12:59:59 87 5.2% 0.02240.3 KB 3.8% 0.07
Apr 20 13:00:00 - 13:59:59 100 5.9% 0.03495.2 KB 7.8% 0.14
Apr 20 14:00:00 - 14:59:59 75 4.4% 0.02211.4 KB 3.3% 0.06
Apr 20 15:00:00 - 15:59:59 54 3.2% 0.01145.4 KB 2.3% 0.04
Apr 20 16:00:00 - 16:59:59 88 5.2% 0.02389.8 KB 6.1% 0.11
Apr 20 17:00:00 - 17:59:59 100 5.9% 0.03452.9 KB 7.1% 0.13
Apr 20 18:00:00 - 18:59:59 105 6.2% 0.03335.0 KB 5.2% 0.09
Apr 20 19:00:00 - 19:59:59 63 3.7% 0.02353.3 KB 5.5% 0.10
Apr 20 20:00:00 - 20:59:59 126 7.5% 0.04402.2 KB 6.3% 0.11
Apr 20 21:00:00 - 21:59:59 121 7.2% 0.03410.8 KB 6.4% 0.11
Apr 20 22:00:00 - 22:59:59 84 5.0% 0.02310.8 KB 4.9% 0.09
Apr 20 23:00:00 - 23:59:59 77 4.6% 0.02286.9 KB 4.5% 0.08
Apr 21 00:00:00 - 00:59:59 77 4.6% 0.02223.3 KB 3.5% 0.06
Apr 21 01:00:00 - 01:59:59 115 6.8% 0.03543.1 KB 8.5% 0.15
Apr 21 02:00:00 - 02:59:59 56 3.3% 0.02211.3 KB 3.3% 0.06
Apr 21 03:00:00 - 03:59:59 49 2.9% 0.01159.2 KB 2.5% 0.04
Apr 21 04:00:00 - 04:15:02 12 0.7% 0.0151.8 KB 0.8% 0.06
TOTAL: 24:00:01 1688 100.0% 0.026.2 MB 100.0% 0.07
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1news.nntp4.net 156 44 0 0 0 0 0 0 112
2news.glou.org 14 0 0 0 0 0 0 0 14
3nntp.terraraq.uk 5 0 0 0 0 0 0 0 5
4gegeweb-out.news.tnetconsulting.net 4 0 0 0 0 0 0 0 4
5i2pn.org 3 0 0 0 0 0 0 0 3
TOTAL: 5 182 44 0 0 0 0 0 0 138

Unwanted newsgroups [Top 20]:

NewsgroupCount
linux.kernel.git 21
linux.kernel.netdev 20
soc.culture.russia 2
news.test 1
TOTAL: 4 44

INND Perl filter [Top 20]:

ReasonCount
Too many newsgroups 76
Bad path (news.giganews.com.POSTED) 56
Cancels abusifs 2
Cancel of non-existing ID <vtt8od$2q3ir$1@dont-email.me> 1
No Cancel-Key matches Cancel-Lock. target=<6804de64$0$29712$426a34cc@news.free.fr> 1
HTML Multipart 1
No Cancel-Key matches Cancel-Lock. target=<680514a0$0$28077$426a74cc@news.free.fr> 1
TOTAL: 7 138

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1i2pn.org 2323 53 1516 7 0 20 2%23:57:36
2news.tnetconsulting.net 2506 9 1668 7 0 46 0%23:58:01
3news.gegeweb.org 1335 6 1207 0 0 0 0%23:49:52
4news.nntp4.net 1191 1 1118 0 0 0 0%23:47:12
5news.pasdenom.info 1284 0 1222 0 0 0 0%23:50:53
6news.samoylyk.net 1859 0 1365 0 0 146 0%23:54:57
7nntp.terraraq.uk 921 0 858 0 0 1 0%23:18:34
8news.aioe.org 0 0 0 0 0 1442 0%24:00:01
TOTAL: 8 11419 69 8954 14 0 1655 0%190:37:06
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1i2pn.org300.9 KB70.1 KB371.0 KB0.0 KB/s6.2 KB23:57:36
2news.tnetconsulting.net18.1 KB30.5 KB48.6 KB0.0 KB/s3.0 KB23:58:01
3news.gegeweb.org12.0 KB0.0 KB12.0 KB0.0 KB/s2.0 KB23:49:52
4news.nntp4.net7.3 KB0.0 KB7.3 KB0.0 KB/s7.3 KB23:47:12
5news.pasdenom.info0.0 KB0.0 KB0.0 KB0.0 KB/s023:50:53
6news.samoylyk.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:54:57
7nntp.terraraq.uk0.0 KB0.0 KB0.0 KB0.0 KB/s023:18:34
8news.aioe.org0.0 KB0.0 KB0.0 KB0.0 KB/s024:00:01
TOTAL: 8338.2 KB100.6 KB438.9 KB0.0 KB/s5.3 KB190:37:06
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1syn-066-061-096-239.res.spectrum.com 2 85.9 KB 1 0 000:00:06
TOTAL: 1 2 85.9 KB 1 0 000:07:00

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.res.spectrum.com 2 85.9 KB 1 0 000:00:06
2*.ip.linodeusercontent.com 50 00.0 KB 0 0 000:00:14
3*.211.203.35.bc.googleusercontent.com 1 00.0 KB 0 0 000:00:00
4unresolved 15 00.0 KB 0 0 000:04:24
5*.210.203.35.bc.googleusercontent.com 1 00.0 KB 0 0 000:00:00
6*.us-east-2.compute.amazonaws.com 12 00.0 KB 0 0 000:00:03
7*.218.231.35.bc.googleusercontent.com 9 00.0 KB 0 0 000:00:05
8*.gegeweb.eu 288 00.0 KB 0 0 000:02:01
9*.do.binaryedge.ninja 1 00.0 KB 0 0 000:00:02
TOTAL: 9 379 85.9 KB 1 0 000:07:00

NNRP auth users [Top 20]:

UserConn
mailman 288
TOTAL: 1 288

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
mail.gegeweb.eu 4.715 4.379 1.82200:02:01
206.168.34.94 0.033 0.025 0.00000:00:33
206.168.34.217 0.035 0.023 0.00000:00:31
206.168.34.42 0.050 0.042 0.00000:00:31
206.168.34.197 0.037 0.020 0.00000:00:31
206.168.34.76 0.014 0.014 0.00000:00:31
206.168.34.41 0.030 0.030 0.00000:00:30
206.168.34.212 0.022 0.007 0.00000:00:30
206.168.34.113 0.031 0.027 0.00000:00:30
172-105-246-139.ip.linodeusercontent.com 1.232 0.680 0.00000:00:14
syn-066-061-096-239.res.spectrum.com 0.040 0.036 0.00000:00:06
206.168.34.67 0.021 0.016 0.00000:00:05
47.218.231.35.bc.googleusercontent.com 0.129 0.124 0.00000:00:05
147.185.132.73 0.014 0.009 0.00000:00:03
prod-barium-sfo2-25.do.binaryedge.ninja 0.018 0.005 0.00000:00:02
147.185.132.201 0.025 0.025 0.00000:00:02
ec2-13-59-180-67.us-east-2.compute.amazonaws.com 0.068 0.104 0.00000:00:01
30.210.203.35.bc.googleusercontent.com 0.024 0.016 0.00000:00:00
ec2-13-58-155-18.us-east-2.compute.amazonaws.com 0.088 0.049 0.00000:00:00
ec2-3-129-62-250.us-east-2.compute.amazonaws.com 0.130 0.089 0.00000:00:00
TOTAL: 23 6.813 5.754 1.82200:07:00

Curious NNRP server explorers [Top 20]:

SystemConn
mail.gegeweb.eu 288
172-105-246-139.ip.linodeusercontent.com 50
47.218.231.35.bc.googleusercontent.com 9
ec2-3-129-62-250.us-east-2.compute.amazonaws.com 5
ec2-13-59-180-67.us-east-2.compute.amazonaws.com 4
ec2-13-58-155-18.us-east-2.compute.amazonaws.com 3
206.168.34.42 3
147.185.132.201 1
82.211.203.35.bc.googleusercontent.com 1
30.210.203.35.bc.googleusercontent.com 1
206.168.34.217 1
206.168.34.94 1
147.185.132.73 1
206.168.34.67 1
prod-barium-sfo2-25.do.binaryedge.ninja 1
206.168.34.76 1
206.168.34.212 1
194.165.16.163 1
206.168.34.197 1
88.214.25.124 1
TOTAL: 22 377

NNRP gethostbyaddr failures [Top 20]:

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

NNRP unrecognized commands (by host):

SystemConn
47.218.231.35.bc.googleusercontent.com 32
ec2-13-59-180-67.us-east-2.compute.amazonaws.com 12
ec2-3-129-62-250.us-east-2.compute.amazonaws.com 11
30.210.203.35.bc.googleusercontent.com 4
82.211.203.35.bc.googleusercontent.com 4
206.168.34.67 1
194.165.16.163 1
TOTAL: 7 65

NNRP unrecognized commands (by command):

CommandCount
GET / HTTP/1.1 7
Accept-Encoding: gzip 7
PING 5fc1c959-aba0-4ac0-a110-8c45a64443a... 5
#026#003#001 4
Host: peertube.gegeweb.eu 3
Connection: close 3
Accept: */* 3
#001 3
User-Agent: Mozilla/5.0 (Windows NT 10.0... 3
Host: 45.13.105.36:119 3
User-Agent: Mozilla/5.0 (Macintosh; Inte... 3
Host: 45.13.105.36:563 2
User-Agent: Expanse, a Palo Alto Network... 2
]"Œßb=±\•iÃÂ#034hNŒiüÛÆ›ó#024Ú#021)RqUâ#010( kg% 1
SSH-2.0-Go 1
EHLO www.censys.io 1
GET /getcmd HTTP/1.1 1
WÐ#017ƒ8×Ñ 1
”—#030µ£ƒä…,µw!#013#{%rNjôa>²7I#005x‡5Ã#026u#005#010¨R#003Ä_Š... 1
Õ¹gŠP#003Ý#030´)V¾¤7#010Á×#n[‰¸»™¹#026y#007à>Bœ=eºUfKƒ¬... 1
Accept-Encoding: Accept-Encoding:,defate... 1
{"id": 1, "method": "mining.subscribe", ... 1
\¼¶·©0Æ”#025‰ˆ#025#020K[/½b\x7fo¹#015#004i%QªªÝ##021ÈUŠð«1v„... 1
Token: 3b62a3551cb0dd82 1
#026#003#001#005¨#001 1
ïTFÈ3fœ€#026èæ†#031L(Î¥7¹xh4ܳD#023Œ0¥#014qs#005#001šRÜ¢#016... 1
#003 1
#021ì 1
[£ˆ[…š6¾$}Fó2å 1
À#024#023#001#023#002#023#003#001 1
TOTAL: 30 65

NNRP client timeouts [Top 20]:

SystemConnPeer
194.165.16.163 1 1
TOTAL: 1 1 4

Newsgroup request counts (by category):

CategoryCountPct
1grisbi 8100.0%
TOTAL: 1 8100.0%

Newsgroup request counts (by newsgroup) [Top 100]:

NewsgroupCount
1grisbi.test 8
TOTAL: 1 8
innreport from INN 2.6.4 based on work (c) 1996-1999 by Fabien Tassin <fta@sofaraway.org>
Local contact: usenet@niel.me