Daily Usenet report for news.niel.me: Nov 25 04:15:02

Unknown entries from news log file:

First 1 / 1 lines (100.0%)

Nov 26 01:30:03 rpi-studio innd: filter: No Cancel-Key[sha1:F1H/ASXnHGBqU3+wk/jcx4NX7PY=] matches Cancel-Lock[sha1:Uibg2cwxzUSplikDVbc5TiOEqs0=] target=<de-gruppen-finden-19.11.2022@dnqmail.priggish.de>

Log entries by program:

Program name	Lines	%Lines	Size	%Size
inn	3590	38.6%	674.0 KB	43.5%
innd	2515	27.0%	422.6 KB	27.2%
innfeed	1689	18.1%	299.8 KB	19.3%
nnrpd	1516	16.3%	154.3 KB	10.0%
controlchan	1	0.0%	0.0 KB	0.0%
nocem	1	0.0%	0.1 KB	0.0%
TOTAL: 6	9312	100.0%	1.5 MB	100.0%

History cache:

Reason	Count	%Count
Positive hits	23204	62.5%
Negative hits	10371	27.9%
Do not exist	3539	9.5%
Cache misses	2	0.0%
TOTAL: 4	37116	100.0%

INND timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
artcncl/perl	00:00:00.023	0.0%	16	1.000	1.438	2.500
article cancel	00:00:00.003	0.0%	17	0.000	0.176	1.000
article cleanup	00:00:00.080	0.0%	3550	0.000	0.023	0.167
article logging	00:00:00.255	0.0%	3555	0.000	0.072	0.333
article parse	00:00:00.656	0.0%	7220	0.000	0.091	0.294
article write	00:00:01.992	0.0%	3099	0.167	0.643	2.763
artlog/artcncl	00:00:00.001	0.0%	17	0.000	0.059	0.250
artlog/artcncl/perl	00:00:00.002	0.0%	16	0.000	0.125	1.000
data move	00:00:00.110	0.0%	40405	0.000	0.003	0.020
hisgrep/artcncl	00:00:00.000	0.0%	17	0.000	0.000	0.000
hisgrep/artcncl/perl	00:00:00.000	0.0%	16	0.000	0.000	0.000
hisgrep/perl	00:00:00.002	0.0%	17	0.000	0.118	0.500
hishave/artcncl	00:00:00.000	0.0%	17	0.000	0.000	0.000
hishave/artcncl/perl	00:00:00.000	0.0%	16	0.000	0.000	0.000
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	00:00:00.475	0.0%	37163	0.000	0.013	0.034
history sync	00:00:00.043	0.0%	392	0.000	0.110	0.667
history write	00:00:00.776	0.0%	3547	0.000	0.219	0.556
hiswrite/artcncl	00:00:00.000	0.0%	0	0.000	0.000	0.000
idle	24:00:29.227	100.0%	40230	638.362	2148.378	8457.310
nntp read	00:00:01.211	0.0%	40255	0.000	0.030	0.072
overview write	00:00:02.313	0.0%	3099	0.000	0.746	4.000
perl filter	00:00:16.379	0.0%	3547	3.017	4.618	15.333
python filter	00:00:00.006	0.0%	3547	0.000	0.002	0.083
site send	00:00:01.019	0.0%	6275	0.000	0.162	0.525
TOTAL: 24:01:07.528	24:00:54.573	100.0%	-	-	-	-

INNfeed timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article new	00:00:00.031	0.0%	3100	0.000	0.010	0.083
article prepare	00:00:00.000	0.0%	480	0.000	0.000	0.000
article read	00:00:00.018	0.0%	70	0.000	0.257	3.000
backlog stats	00:00:00.108	0.0%	49101	0.000	0.002	0.014
callbacks	00:00:00.000	0.0%	0	0.000	0.000	0.000
data read	00:00:00.652	0.0%	28748	0.000	0.023	0.100
data write	00:00:01.665	0.0%	25696	0.020	0.065	0.111
idle	23:50:28.582	100.0%	49101	794.185	1748.001	9233.723
status file	00:00:00.482	0.0%	179	1.000	2.693	13.000
TOTAL: 23:50:35.915	23:50:31.538	100.0%	-	-	-	-

nnrpd timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
idle	00:00:32.500	38.2%	1445	11.600	22.491	9362.000
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:00:00.104	0.1%	3199	0.000	0.033	1.000
TOTAL: 00:01:25.137	00:00:32.604	38.3%	-	-	-	-

Control commands to INND:

Command	Number
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):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed
1	news-out.aioe.org	2	3123	1330	1752	41	42%	23:53:32
2	i2pn.org	3	3557	824	2527	206	23%	26:05:28
3	news.glou.org	1	2870	515	2270	85	17%	22:15:12
4	feed-out.gegeweb.org	2	2108	155	1952	1	7%	23:59:46
5	usenet.pasdenom.info	1	2501	148	2346	7	5%	23:59:53
6	news.nntp4.net	2	3330	32	3185	113	0%	23:34:00
7	gegeweb-out.news.tnetconsulting.net	1	3142	31	3106	5	0%	23:59:53
8	news.samoylyk.net	2	3028	9	3018	1	0%	23:03:10
9	nntp.terraraq.uk	1	101	5	96	0	4%	01:18:20
10	localhost	25	0	0	0	0	0%	00:00:00
TOTAL: 10		40	23760	3049	20252	459	12%	192:09:14

Incoming Volume (INN):

Server		AcceptVol	DupVol	RejVol	TotalVol	%Acc	Vol/Art
1	news-out.aioe.org	4.4 MB	0.0 KB	189.6 KB	4.6 MB	95%	3.4 KB
2	news.glou.org	4.3 MB	0.0 KB	268.4 KB	4.5 MB	94%	7.7 KB
3	i2pn.org	2.7 MB	0.0 KB	575.1 KB	3.2 MB	82%	3.2 KB
4	feed-out.gegeweb.org	752.6 KB	0.0 KB	1.3 KB	754.0 KB	99%	4.8 KB
5	usenet.pasdenom.info	357.5 KB	0.0 KB	9.5 KB	366.9 KB	97%	2.4 KB
6	news.nntp4.net	285.0 KB	1.6 KB	715.6 KB	1002.2 KB	28%	6.9 KB
7	news.samoylyk.net	275.9 KB	1.6 KB	1.6 KB	279.1 KB	98%	27.9 KB
8	gegeweb-out.news.tnetconsulting.net	275.5 KB	0.0 KB	56.5 KB	332.0 KB	82%	9.2 KB
9	nntp.terraraq.uk	27.2 KB	0.0 KB	0.0 KB	27.2 KB	100%	5.4 KB
10	localhost	0.0 KB	0.0 KB	0.0 KB	0.0 KB	0%	0
TOTAL: 10		13.3 MB	3.2 KB	1.8 MB	15.1 MB	88%	4.4 KB

Incoming articles:

Date	Articles	%Arts	Art/sec	Size	%Size	KB/sec
Nov 25 04:15:02 - 04:59:59	72	2.3%	0.03	1003.6 KB	7.4%	0.37
Nov 25 05:00:00 - 05:59:59	62	2.0%	0.02	565.2 KB	4.2%	0.16
Nov 25 06:00:00 - 06:59:59	97	3.1%	0.03	363.5 KB	2.7%	0.10
Nov 25 07:00:00 - 07:59:59	72	2.3%	0.02	256.5 KB	1.9%	0.07
Nov 25 08:00:00 - 08:59:59	76	2.5%	0.02	269.1 KB	2.0%	0.07
Nov 25 09:00:00 - 09:59:59	103	3.3%	0.03	430.9 KB	3.2%	0.12
Nov 25 10:00:00 - 10:59:59	108	3.5%	0.03	395.1 KB	2.9%	0.11
Nov 25 11:00:00 - 11:59:59	83	2.7%	0.02	346.1 KB	2.6%	0.10
Nov 25 12:00:00 - 12:59:59	120	3.9%	0.03	384.5 KB	2.8%	0.11
Nov 25 13:00:00 - 13:59:59	101	3.3%	0.03	308.8 KB	2.3%	0.09
Nov 25 14:00:00 - 14:59:59	149	4.8%	0.04	592.6 KB	4.4%	0.16
Nov 25 15:00:00 - 15:59:59	176	5.7%	0.05	567.4 KB	4.2%	0.16
Nov 25 16:00:00 - 16:59:59	161	5.2%	0.04	565.7 KB	4.2%	0.16
Nov 25 17:00:00 - 17:59:59	152	4.9%	0.04	558.8 KB	4.1%	0.16
Nov 25 18:00:00 - 18:59:59	209	6.8%	0.06	699.7 KB	5.2%	0.19
Nov 25 19:00:00 - 19:59:59	203	6.6%	0.06	769.8 KB	5.7%	0.21
Nov 25 20:00:00 - 20:59:59	154	5.0%	0.04	651.7 KB	4.8%	0.18
Nov 25 21:00:00 - 21:59:59	250	8.1%	0.07	774.7 KB	5.7%	0.22
Nov 25 22:00:00 - 22:59:59	162	5.2%	0.04	464.9 KB	3.4%	0.13
Nov 25 23:00:00 - 23:59:59	130	4.2%	0.04	756.9 KB	5.6%	0.21
Nov 26 00:00:00 - 00:59:59	183	5.9%	0.05	1.8 MB	13.5%	0.51
Nov 26 01:00:00 - 01:59:59	94	3.0%	0.03	425.6 KB	3.2%	0.12
Nov 26 02:00:00 - 02:59:59	89	2.9%	0.02	275.1 KB	2.0%	0.08
Nov 26 03:00:00 - 03:59:59	67	2.2%	0.02	195.1 KB	1.4%	0.05
Nov 26 04:00:00 - 04:15:02	23	0.7%	0.03	56.5 KB	0.4%	0.06
TOTAL: 24:00:00	3096	100.0%	0.04	13.2 MB	100.0%	0.16

Sites sending bad articles:

Server		Total	Group	Duplic	Other
1	i2pn.org	188	0	0	188
2	news.nntp4.net	114	0	1	113
3	news.glou.org	88	0	0	88
4	news-out.aioe.org	44	2	0	42
5	nntp.terraraq.uk	10	0	1	9
6	usenet.pasdenom.info	9	0	0	9
7	gegeweb-out.news.tnetconsulting.net	5	2	0	3
8	news.samoylyk.net	2	0	1	1
9	feed-out.gegeweb.org	1	0	0	1
TOTAL: 9		461	4	3	454

Unwanted newsgroups [Top 20]:

Newsgroup	Count
fr.petites-annonces.informatique.materiel	2
uk.sport.cricket	1
news.test	1
TOTAL: 3	4

INND Perl filter [Top 20]:

Reason	Count
EMP (phl)	153
EMP (phn nph)	146
Bad path (news.giganews.com.POSTED)	89
Too many newsgroups	26
EMP (md5)	25
EMP (phn path)	8
Cancels abusifs	2
TOTAL: 7	449

Miscellaneous innd statistics [Top 10]:

Event	Server	Number
Including strange strings
	news-out.aioe.org	3
	news.nntp4.net	1
	news.samoylyk.net	1
	TOTAL: 3	5
TOTAL: 1		5

Outgoing Feeds (innfeed) by Articles:

Server		Offered	Taken	Refused	Reject	Spool	%Took	Elapsed
1	news.nntp4.net	3413	40	3018	0	0	1%	23:59:44
2	nntp.terraraq.uk	2429	22	1965	14	0	0%	23:58:44
3	i2pn.org	4049	12	2285	8	6	0%	23:59:55
4	news.aioe.org	1485	4	1334	0	0	0%	23:36:10
5	news.tnetconsulting.net	4890	3	3085	7	13	0%	23:59:55
6	news.samoylyk.net	3725	2	3078	7	0	0%	23:59:53
7	news.gegeweb.org	2983	1	2937	0	0	0%	23:59:24
8	news.pasdenom.info	2960	0	2629	0	0	0%	23:59:06
TOTAL: 8		25934	84	20331	36	19	0%	191:32:51

Outgoing Feeds (innfeed) by Volume:

Server		AcceptVol	RejectVol	TotalVol	Vol/Art	Elapsed
1	news.nntp4.net	1.3 MB	0.0 KB	1.3 MB	33.3 KB	23:59:44
2	nntp.terraraq.uk	495.8 KB	596.3 KB	1.1 MB	30.3 KB	23:58:44
3	i2pn.org	66.7 KB	57.4 KB	124.0 KB	6.2 KB	23:59:55
4	news.aioe.org	38.2 KB	0.0 KB	38.2 KB	9.6 KB	23:36:10
5	news.samoylyk.net	14.5 KB	88.7 KB	103.3 KB	11.5 KB	23:59:53
6	news.tnetconsulting.net	8.4 KB	88.7 KB	97.1 KB	9.7 KB	23:59:55
7	news.gegeweb.org	1.3 KB	0.0 KB	1.3 KB	1.3 KB	23:59:24
8	news.pasdenom.info	0.0 KB	0.0 KB	0.0 KB	0	23:59:06
TOTAL: 8		1.9 MB	831.1 KB	2.7 MB	23.2 KB	191:32:51

NNRP readership statistics:

System		Conn	Elapsed
1	distinguished.monitoring.internet-measurement.com	1	00:00:00
2	192.241.197.78	1	00:00:01
3	proud.monitoring.internet-measurement.com	1	00:00:00
4	reliable.monitoring.internet-measurement.com	1	00:00:00
5	empathetic.monitoring.internet-measurement.com	1	00:00:00
6	183.136.225.9	1	00:00:05
7	magnanimous.monitoring.internet-measurement.com	1	00:00:00
8	mail.gegeweb.eu	288	00:01:00
9	appealing.monitoring.internet-measurement.com	1	00:00:00
10	renowned.monitoring.internet-measurement.com	1	00:00:00
11	legendary.monitoring.internet-measurement.com	1	00:00:00
12	admirable.monitoring.internet-measurement.com	1	00:00:05
13	upright.monitoring.internet-measurement.com	1	00:00:00
14	198.199.94.242	1	00:00:09
15	agreeable.monitoring.internet-measurement.com	1	00:00:00
TOTAL: 15		302	00:01:24

NNRP readership statistics (by domain):

System		Conn	Elapsed
1	unresolved	3	00:00:16
2	*.monitoring.internet-measurement.com	11	00:00:07
3	*.gegeweb.eu	288	00:01:00
TOTAL: 3		302	00:01:24

NNRP auth users [Top 20]:

User	Conn
mailman	288
TOTAL: 1	288

NNRP total resource statistics [Top 20]:

System	User(ms)	System(ms)	Idle(ms)	Elapsed
mail.gegeweb.eu	7.980	8.258	2.378	00:01:00
198.199.94.242	0.020	0.030	0.000	00:00:09
admirable.monitoring.internet-measurement.com	0.058	0.033	0.000	00:00:05
183.136.225.9	0.019	0.039	0.000	00:00:05
192.241.197.78	0.019	0.037	0.000	00:00:01
reliable.monitoring.internet-measurement.com	0.086	0.000	0.000	00:00:00
legendary.monitoring.internet-measurement.com	0.082	0.000	0.000	00:00:00
appealing.monitoring.internet-measurement.com	0.018	0.018	0.000	00:00:00
agreeable.monitoring.internet-measurement.com	0.051	0.000	0.000	00:00:00
upright.monitoring.internet-measurement.com	0.018	0.018	0.000	00:00:00
distinguished.monitoring.internet-measurement.com	0.018	0.018	0.000	00:00:00
renowned.monitoring.internet-measurement.com	0.022	0.015	0.000	00:00:00
empathetic.monitoring.internet-measurement.com	0.012	0.012	0.000	00:00:00
proud.monitoring.internet-measurement.com	0.009	0.009	0.000	00:00:00
magnanimous.monitoring.internet-measurement.com	0.017	0.000	0.000	00:00:00
TOTAL: 15	8.429	8.487	2.378	00:01:24

NNRP unrecognized commands (by host):

System	Conn
183.136.225.9	5
192.241.197.78	1
TOTAL: 2	6

NNRP unrecognized commands (by command):

Command	Count
Connection: keep-alive	1
Accept: /	1
GET / HTTP/1.1	1
MGLNDD_45.13.105.36_119	1
Host: 45.13.105.36:119	1
User-Agent: Mozilla/5.0 (Macintosh; Inte...	1
TOTAL: 6	6

Daily Usenet report for news.niel.me

Nov 25 04:15:02 -- Nov 26 04:15:02