Daily Usenet report for news.niel.me

Feb 28 04:15:02 -- Mar 1 04:15:01

Unknown entries from news log file:

First 1 / 1 lines (100.0%)

Feb 28 17:47:02 rpi-studio innd: filter: No Cancel-Key[sha1:nh24R2EVPvxgvljGzW6fr4WW6hg=] matches Cancel-Lock[sha1:jynb1ineImA5AFGHnupvgGqyuX8=] target=<63fe2ae4$0$2999$426a74cc@news.free.fr>

Log entries by program:

Program nameLines%LinesSize%Size
inn 3936 38.5%753.2 KB 44.7%
innd 2451 24.0%412.8 KB 24.5%
nnrpd 2063 20.2%220.6 KB 13.1%
innfeed 1763 17.2%295.1 KB 17.5%
nocem 8 0.1%0.7 KB 0.0%
controlchan 6 0.1%1.0 KB 0.1%
TOTAL: 6 10227 100.0%1.6 MB100.0%

History cache:

ReasonCount%Count
Positive hits 21131 54.0%
Negative hits 14134 36.1%
Do not exist 3884 9.9%
Cache misses 0 0.0%
TOTAL: 4 39149 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
artcncl/perl00:00:00.020 0.0%13 1.000 1.538 4.000
article cancel00:00:00.003 0.0%19 0.000 0.158 1.000
article cleanup00:00:00.086 0.0%3903 0.000 0.022 0.167
article logging00:00:00.290 0.0%3916 0.000 0.074 0.333
article parse00:00:00.729 0.0%9203 0.000 0.079 0.226
article write00:00:05.532 0.0%3459 0.294 1.599 3.522
artlog/artcncl00:00:00.001 0.0%19 0.000 0.053 0.500
artlog/artcncl/perl00:00:00.001 0.0%13 0.000 0.077 1.000
data move00:00:00.147 0.0%42452 0.000 0.003 0.022
hisgrep/artcncl00:00:00.001 0.0%19 0.000 0.053 1.000
hisgrep/artcncl/perl00:00:00.001 0.0%13 0.000 0.077 1.000
hisgrep/perl00:00:00.000 0.0%46 0.000 0.000 0.000
hishave/artcncl00:00:00.000 0.0%19 0.000 0.000 0.000
hishave/artcncl/perl00:00:00.000 0.0%13 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:00.480 0.0%39298 0.000 0.012 0.030
history sync00:00:00.060 0.0%405 0.000 0.148 1.000
history write00:00:00.859 0.0%3902 0.000 0.220 0.778
hiswrite/artcncl00:00:00.000 0.0%0 0.000 0.000 0.000
idle24:00:34.849100.0%44278 634.538 1952.095 8832.853
nntp read00:00:01.321 0.0%43430 0.000 0.030 0.108
overview write00:00:01.948 0.0%3459 0.077 0.563 4.250
perl filter00:00:16.829 0.0%3902 2.463 4.313 13.267
python filter00:00:00.010 0.0%3902 0.000 0.003 0.091
site send00:00:01.331 0.0%6996 0.000 0.190 0.556
TOTAL: 24:01:17.05824:01:04.498100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.029 0.0%3563 0.000 0.008 0.100
article prepare00:00:00.000 0.0%92 0.000 0.000 0.000
article read00:00:00.010 0.0%18 0.000 0.556 8.000
backlog stats00:00:00.142 0.0%41431 0.000 0.003 0.019
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:00.644 0.0%25753 0.000 0.025 0.067
data write00:00:01.237 0.0%22692 0.000 0.055 0.113
idle23:58:27.212100.0%41431 963.679 2083.155 5518.633
status file00:00:00.480 0.0%208 1.000 2.308 8.000
TOTAL: 23:58:33.26123:58:29.754100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:55.715 32.3%1530 21.600 36.415 1878.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.085 0.0%3440 0.000 0.025 0.500
TOTAL: 00:02:52.30100:00:55.800 32.4%----

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

Control Channel:

SendernewgrouprmgroupOtherBad PGPDoItOK
us-control@lists.killfile.org001001
TOTAL001001

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1feed-out.gegeweb.org 5 2197 927 1270 0 42%24:49:41
2i2pn.org 4 3357 898 2327 132 26%21:13:11
3news.nntp4.net 2 3731 532 3060 139 14%25:41:37
4news.glou.org 2 2932 359 2509 64 12%21:34:22
5gegeweb-out.news.tnetconsulting.net 2 5317 284 4996 37 5%37:34:29
6usenet.pasdenom.info 2 2422 170 2215 37 7%24:59:26
7nntp.terraraq.uk 1 706 85 616 5 12%05:50:28
8news.samoylyk.net 2 3362 56 3292 14 1%21:55:35
9localhost 27 0 0 0 0 0%00:00:00
TOTAL: 9 47 24024 3311 20285 428 13%183:38:49

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1news.glou.org4.3 MB0.0 KB172.0 KB4.5 MB 96%10.9 KB
2feed-out.gegeweb.org2.7 MB0.0 KB0.0 KB2.7 MB100%3.0 KB
3i2pn.org2.7 MB0.0 KB347.6 KB3.0 MB 88%3.0 KB
4news.nntp4.net2.6 MB0.0 KB459.0 KB3.1 MB 85%4.7 KB
5gegeweb-out.news.tnetconsulting.net1.5 MB3.6 KB84.8 KB1.6 MB 94%5.2 KB
6news.samoylyk.net801.4 KB0.0 KB22.5 KB823.9 KB 97%11.8 KB
7usenet.pasdenom.info373.1 KB0.0 KB58.0 KB431.1 KB 86%2.1 KB
8nntp.terraraq.uk307.8 KB0.0 KB19.2 KB327.0 KB 94%3.6 KB
9localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 915.4 MB3.6 KB1.1 MB16.5 MB 93%4.5 KB

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Feb 28 04:15:02 - 04:59:59 81 2.3% 0.03395.9 KB 2.4% 0.15
Feb 28 05:00:00 - 05:59:59 90 2.6% 0.031.5 MB 9.2% 0.42
Feb 28 06:00:00 - 06:59:59 82 2.4% 0.02643.8 KB 3.9% 0.18
Feb 28 07:00:00 - 07:59:59 126 3.7% 0.04343.5 KB 2.1% 0.10
Feb 28 08:00:00 - 08:59:59 86 2.5% 0.02319.2 KB 1.9% 0.09
Feb 28 09:00:00 - 09:59:59 134 3.9% 0.04444.9 KB 2.7% 0.12
Feb 28 10:00:00 - 10:59:59 108 3.1% 0.03330.1 KB 2.0% 0.09
Feb 28 11:00:00 - 11:59:59 104 3.0% 0.03286.0 KB 1.7% 0.08
Feb 28 12:00:00 - 12:59:59 105 3.0% 0.03398.6 KB 2.4% 0.11
Feb 28 13:00:00 - 13:59:59 143 4.1% 0.04569.9 KB 3.4% 0.16
Feb 28 14:00:00 - 14:59:59 113 3.3% 0.03411.5 KB 2.5% 0.11
Feb 28 15:00:00 - 15:59:59 147 4.3% 0.04534.8 KB 3.2% 0.15
Feb 28 16:00:00 - 16:59:59 252 7.3% 0.071.3 MB 7.8% 0.36
Feb 28 17:00:00 - 17:59:59 187 5.4% 0.051.1 MB 6.8% 0.31
Feb 28 18:00:00 - 18:59:59 189 5.5% 0.05648.8 KB 3.9% 0.18
Feb 28 19:00:00 - 19:59:59 230 6.7% 0.06958.2 KB 5.8% 0.27
Feb 28 20:00:00 - 20:59:59 214 6.2% 0.06724.2 KB 4.4% 0.20
Feb 28 21:00:00 - 21:59:59 173 5.0% 0.05644.9 KB 3.9% 0.18
Feb 28 22:00:00 - 22:59:59 189 5.5% 0.051.7 MB 10.3% 0.47
Feb 28 23:00:00 - 23:59:59 193 5.6% 0.051.1 MB 6.8% 0.31
Mar 1 00:00:00 - 00:59:59 193 5.6% 0.05715.4 KB 4.3% 0.20
Mar 1 01:00:00 - 01:59:59 123 3.6% 0.03529.6 KB 3.2% 0.15
Mar 1 02:00:00 - 02:59:59 89 2.6% 0.02405.8 KB 2.4% 0.11
Mar 1 03:00:00 - 03:59:59 72 2.1% 0.02393.9 KB 2.4% 0.11
Mar 1 04:00:00 - 04:15:01 24 0.7% 0.0388.8 KB 0.5% 0.10
TOTAL: 23:59:59 3447 100.0% 0.0416.2 MB 100.0% 0.19

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1i2pn.org 144 0 0 0 0 0 0 0 144
2news.nntp4.net 142 0 0 0 0 0 0 0 142
3news.glou.org 65 0 0 0 0 0 0 0 65
4usenet.pasdenom.info 39 0 0 0 0 0 0 0 39
5gegeweb-out.news.tnetconsulting.net 26 0 0 1 0 0 0 0 25
6nntp.terraraq.uk 19 0 0 0 0 0 0 0 19
7news.samoylyk.net 16 0 0 0 0 0 0 0 16
8feed-out.gegeweb.org 6 0 0 0 0 0 0 0 6
TOTAL: 8 457 0 0 1 0 0 0 0 456

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 116
EMP (phn path) 109
Bad path (news.giganews.com.POSTED) 79
EMP (phl) 72
Too many newsgroups 14
Too many newsgroups (meow) 7
EMP (phn nph) 6
EMP (phr nph) 4
Cancels abusifs 2
Cancel of non-existing ID <1rjLL.3490785$miq3.944072@fx02.ams4> 1
Cancel of non-existing ID <g6jLL.3530467$WRz3.3249826@fx03.ams4> 1
Cancel of non-existing ID <86jLL.1245998$gs1.404353@fx15.ams4> 1
Cancel of non-existing ID <3OiLL.3504396$SIb3.1280202@fx05.ams4> 1
Cancel of non-existing ID <ttm0vs$1bie$1@cabale.usenet-fr.net> 1
No Cancel-Key matches Cancel-Lock. target=<63fe2ae4$0$2999$426a74cc@news.free.fr> 1
Cancel of non-existing ID <VNiLL.3504245$SIb3.347281@fx05.ams4> 1
Cancel of non-existing ID <%qjLL.3490761$miq3.23276@fx02.ams4> 1
Cancel of non-existing ID <SNiLL.3504167$SIb3.2023117@fx05.ams4> 1
Cancel of non-existing ID <j7lLL.3533349$WRz3.1390465@fx03.ams4> 1
Cancel of non-existing ID <%NiLL.3504353$SIb3.1655291@fx05.ams4> 1
TOTAL: 43 443

NoCeM on Spool:

IdGoodBadUniqueTotal
bleachbot@httrack.com6066
TOTAL: 16066

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
feed-out.gegeweb.org 6
news.nntp4.net 3
i2pn.org 2
news.samoylyk.net 2
TOTAL: 4 13
TOTAL: 1 13

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.nntp4.net 2932 12 2849 0 0 30 0%23:59:56
2news.tnetconsulting.net 4883 1 3442 0 0 49 0%23:59:55
3news.gegeweb.org 2610 1 2544 1 0 0 0%23:59:49
4nntp.terraraq.uk 2525 1 2386 4 0 0 0%23:59:19
5news.pasdenom.info 3009 0 2911 1 0 0 0%23:59:56
6news.aioe.org 0 0 0 0 0 2640 0%23:59:56
7i2pn.org 3220 0 2435 2 0 10 0%23:59:55
8news.samoylyk.net 3601 0 3387 0 0 29 0%23:59:55
TOTAL: 8 22780 15 19954 8 0 2758 0%191:58:41

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.nntp4.net227.2 KB0.0 KB227.2 KB0.0 KB/s18.9 KB23:59:56
2news.gegeweb.org7.6 KB6.9 KB14.5 KB0.0 KB/s7.3 KB23:59:49
3news.tnetconsulting.net3.7 KB0.0 KB3.7 KB0.0 KB/s3.7 KB23:59:55
4nntp.terraraq.uk3.0 KB109.8 KB112.8 KB0.0 KB/s22.6 KB23:59:19
5news.pasdenom.info0.0 KB2.4 KB2.4 KB0.0 KB/s2.4 KB23:59:56
6news.aioe.org0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:56
7i2pn.org0.0 KB14.4 KB14.4 KB0.0 KB/s7.2 KB23:59:55
8news.samoylyk.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:59:55
TOTAL: 8241.5 KB133.4 KB375.0 KB0.0 KB/s16.3 KB191:58:41

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
145-79-163-53.ip.linodeusercontent.com 1 00.0 KB 0 0 000:00:00
2angelic.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:01
3fortunate.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
4guernsey.scan.bufferover.run 1 00.0 KB 0 0 000:00:01
5172-105-246-139.ip.linodeusercontent.com 87 00.0 KB 0 0 000:00:24
6lively.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
7bright.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:05
8107.170.238.28 1 00.0 KB 0 0 000:00:00
9212.102.40.218 3 00.0 KB 0 0 000:00:02
10mail.gegeweb.eu 286 00.0 KB 0 0 000:02:01
11champion.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:01
12productive.monitoring.internet-measurement.com 1 00.0 KB 0 0 000:00:00
13sys.gegeweb.eu 2 00.0 KB 0 0 000:00:12
TOTAL: 13 387 00.0 KB 0 0 000:02:51

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.monitoring.internet-measurement.com 6 00.0 KB 0 0 000:00:09
2*.ip.linodeusercontent.com 88 00.0 KB 0 0 000:00:24
3unresolved 4 00.0 KB 0 0 000:00:02
4*.gegeweb.eu 288 00.0 KB 0 0 000:02:13
5*.scan.bufferover.run 1 00.0 KB 0 0 000:00:01
TOTAL: 5 387 00.0 KB 0 0 000:02:51

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.511 4.477 1.85000:02:01
172-105-246-139.ip.linodeusercontent.com 2.091 1.406 0.00000:00:24
sys.gegeweb.eu 0.055 0.053 0.02100:00:12
bright.monitoring.internet-measurement.com 0.067 0.022 0.00000:00:05
212.102.40.218 0.061 0.053 0.00000:00:02
champion.monitoring.internet-measurement.com 0.028 0.019 0.00000:00:01
angelic.monitoring.internet-measurement.com 0.021 0.031 0.00000:00:01
guernsey.scan.bufferover.run 0.045 0.027 0.00000:00:01
45-79-163-53.ip.linodeusercontent.com 0.023 0.035 0.00000:00:00
107.170.238.28 0.018 0.035 0.00000:00:00
lively.monitoring.internet-measurement.com 0.029 0.000 0.00000:00:00
productive.monitoring.internet-measurement.com 0.029 0.000 0.00000:00:00
fortunate.monitoring.internet-measurement.com 0.000 0.029 0.00000:00:00
TOTAL: 13 6.978 6.187 1.87100:02:51

NNRP gethostbyaddr failures [Top 20]:

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

NNRP unrecognized commands (by host):

SystemConn
107.170.238.28 1
TOTAL: 1 1

NNRP unrecognized commands (by command):

CommandCount
MGLNDD_45.13.105.36_119 1
TOTAL: 1 1