Daily Usenet report for csiph.com: Oct 6 04:15:00

Log entries by program:

Program name	Lines	%Lines	Size	%Size
inn	26945	49.0%	5.7 MB	60.7%
innd	23493	42.7%	2.9 MB	31.6%
innfeed	3508	6.4%	623.3 KB	6.5%
nnrpd	1038	1.9%	113.8 KB	1.2%
nocem	22	0.0%	2.5 KB	0.0%
controlchan	1	0.0%	0.1 KB	0.0%
TOTAL: 6	55007	100.0%	9.3 MB	100.0%

History cache:

Reason	Count	%Count
Positive hits	332336	54.2%
Negative hits	253867	41.4%
Do not exist	26297	4.3%
Cache misses	514	0.1%
TOTAL: 4	613014	100.0%

INND timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article cancel	00:00:00.471	0.0%	29	0.000	16.241	82.000
article cleanup	00:00:00.148	0.0%	26307	0.000	0.006	0.043
article logging	00:00:00.702	0.0%	26743	0.000	0.026	1.946
article parse	00:00:01.344	0.0%	66673	0.000	0.020	0.343
article write	00:00:33.001	0.0%	15106	0.200	2.185	56.192
artlog/artcncl	00:00:00.000	0.0%	29	0.000	0.000	0.000
artlog/artparse	00:00:00.017	0.0%	187	0.000	0.091	0.938
data move	00:00:00.186	0.0%	588873	0.000	0.000	0.002
hisgrep/artcncl	00:00:00.049	0.0%	29	0.000	1.690	11.000
hishave/artcncl	00:00:00.025	0.0%	29	0.000	0.862	8.000
hishave/artparse	00:00:00.000	0.0%	179	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:36.487	0.0%	617663	0.002	0.059	0.552
history sync	00:00:01.493	0.0%	350	0.000	4.266	37.000
history write	00:00:55.685	0.1%	26305	0.385	2.117	16.267
hiswrite/artcncl	00:00:00.000	0.0%	0	0.000	0.000	0.000
hiswrite/artparse	00:00:00.710	0.0%	179	0.000	3.966	39.167
idle	23:55:31.449	99.6%	590338	50.302	145.902	435.226
nntp read	00:00:02.241	0.0%	596586	0.001	0.004	0.007
overview write	00:01:52.877	0.1%	15106	0.125	7.472	544.626
perl filter	00:00:28.377	0.0%	26297	0.439	1.079	1.986
python filter	00:00:00.000	0.0%	0	0.000	0.000	0.000
site send	00:00:00.241	0.0%	30238	0.000	0.008	0.036
TOTAL: 24:00:48.919	24:00:05.503	99.9%	-	-	-	-

INNfeed timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article new	00:00:00.038	0.0%	17578	0.000	0.002	0.023
article prepare	00:00:00.002	0.0%	13184	0.000	0.000	0.019
article read	00:00:00.527	0.0%	1727	0.000	0.305	50.000
backlog stats	00:00:00.186	0.0%	351568	0.000	0.001	0.002
callbacks	00:00:00.000	0.0%	0	0.000	0.000	0.000
data read	00:00:01.285	0.0%	274025	0.001	0.005	0.011
data write	00:00:01.609	0.0%	261232	0.001	0.006	0.012
idle	23:55:12.568	100.0%	351568	145.113	244.939	719.734
status file	00:00:01.952	0.0%	270	0.000	7.230	1715.000
TOTAL: 23:55:26.223	23:55:18.167	100.0%	-	-	-	-

nnrpd timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
idle	47:19:46.853	99.9%	711	33.000	239643.956	600164.000
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:00:00.748	0.0%	34022	0.000	0.022	17.750
readart	00:00:00.252	0.0%	29	0.000	8.690	42.000
TOTAL: 47:23:40.183	47:19:47.853	99.9%	-	-	-	-

Control commands to INND:

Command	Number
flush	5
flushlogs	2
go	2
logmode	2
lowmark	1
mode	133
pause	2
paused	2
reload	2
reserve	2
TOTAL: 10	153

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed
1	newsfeeds.xmission.com	2	14559	3864	10667	28	26%	24:23:55
2	csiph-out.news.xs4all.nl	466	25815	3256	14865	7694	12%	68:53:07
3	feeder.eternal-september.org	4	17276	2020	15178	78	11%	23:45:01
4	news-out.mixmin.net	3	16540	1954	14419	167	11%	24:11:57
5	news-out.aioe.org	2	14598	869	13646	83	5%	24:09:01
6	csiph-out.feeder.erje.net	1440	75391	699	74565	127	0%	118:52:22
7	newsfeed.fu-berlin.de	15	21661	618	20842	201	2%	23:23:07
8	newsfeed.neva.ru	146	18034	551	16067	1416	3%	72:08:14
9	csiph-out.news.weretis.net	4	32179	474	31173	532	1%	48:40:36
10	news.fcku.it	9	1783	296	1473	14	16%	22:13:31
11	news-out.neodome.net	2	17206	174	17000	32	1%	23:59:53
12	nntp.pasdenom.info	3	9466	119	9314	33	1%	23:57:41
13	csiph-out.feed.uzoreto.com	864	24241	94	23992	155	0%	71:21:17
14	news.swapon.de	6	1134	40	1094	0	3%	23:43:33
15	news.freedyn.net	1	26416	31	25603	782	0%	23:59:56
16	csiph-out.news.tnetconsulting.net	3	21243	29	21169	45	0%	31:35:16
17	localhost	34	8	8	0	0	100%	00:00:03
18	news.samoylyk.net	2	14650	3	14642	5	0%	23:59:46
19	xanadu-bbs.net	36	326	0	326	0	0%	20:24:07
20	news.bbs.nz	2	14709	0	14709	0	0%	23:59:49
TOTAL: 20		3044	367235	15099	340744	11392	4%	717:42:12

Incoming Volume (INN):

Server		AcceptVol	DupVol	RejVol	TotalVol	%Acc	Vol/Art
1	newsfeeds.xmission.com	13.0 MB	9.3 KB	1.5 MB	14.6 MB	89%	3.8 KB
2	csiph-out.news.xs4all.nl	8.8 MB	3.9 KB	15.2 MB	24.0 MB	36%	2.2 KB
3	feeder.eternal-september.org	5.3 MB	2.3 KB	677.9 KB	5.9 MB	88%	2.9 KB
4	csiph-out.feeder.erje.net	4.8 MB	0.0 KB	1.9 MB	6.7 MB	71%	8.3 KB
5	news-out.mixmin.net	4.3 MB	3.9 KB	360.7 KB	4.7 MB	92%	2.3 KB
6	news-out.aioe.org	3.1 MB	0.0 KB	267.8 KB	3.3 MB	92%	3.6 KB
7	newsfeed.fu-berlin.de	1.4 MB	0.0 KB	330.6 KB	1.7 MB	80%	2.1 KB
8	newsfeed.neva.ru	1.3 MB	0.0 KB	2.0 MB	3.3 MB	38%	1.7 KB
9	csiph-out.news.weretis.net	1.2 MB	0.0 KB	1.7 MB	2.8 MB	40%	2.9 KB
10	csiph-out.feed.uzoreto.com	788.3 KB	0.0 KB	4.4 MB	5.1 MB	14%	21.1 KB
11	news-out.neodome.net	526.7 KB	20.6 KB	1.4 MB	1.9 MB	26%	9.5 KB
12	news.fcku.it	490.4 KB	0.0 KB	17.6 KB	508.0 KB	96%	1.6 KB
13	news.freedyn.net	338.3 KB	7.3 KB	1.8 MB	2.2 MB	15%	2.7 KB
14	nntp.pasdenom.info	295.9 KB	0.0 KB	41.5 KB	337.4 KB	87%	2.2 KB
15	news.swapon.de	93.0 KB	0.0 KB	0.0 KB	93.0 KB	100%	2.3 KB
16	csiph-out.news.tnetconsulting.net	87.9 KB	3.7 KB	257.1 KB	348.7 KB	25%	4.7 KB
17	localhost	13.3 KB	0.0 KB	0.0 KB	13.3 KB	100%	1.7 KB
18	news.samoylyk.net	8.4 KB	0.0 KB	315.9 KB	324.4 KB	2%	40.5 KB
19	xanadu-bbs.net	0.0 KB	0.0 KB	0.0 KB	0.0 KB	0%	0
20	news.bbs.nz	0.0 KB	0.0 KB	0.0 KB	0.0 KB	0%	0
TOTAL: 20		45.6 MB	51.0 KB	32.1 MB	77.8 MB	58%	3.0 KB

Incoming articles:

Date	Articles	%Arts	Art/sec	Size	%Size	KB/sec
Oct 6 04:15:00 - 04:59:59	252	1.7%	0.09	1.5 MB	3.3%	0.58
Oct 6 05:00:00 - 05:59:59	393	2.6%	0.11	1.3 MB	2.8%	0.37
Oct 6 06:00:00 - 06:59:59	409	2.7%	0.11	1.2 MB	2.6%	0.33
Oct 6 07:00:00 - 07:59:59	501	3.3%	0.14	1.3 MB	2.8%	0.36
Oct 6 08:00:00 - 08:59:59	650	4.3%	0.18	2.2 MB	4.9%	0.64
Oct 6 09:00:00 - 09:59:59	727	4.8%	0.20	2.0 MB	4.5%	0.58
Oct 6 10:00:00 - 10:59:59	730	4.8%	0.20	2.0 MB	4.5%	0.58
Oct 6 11:00:00 - 11:59:59	731	4.8%	0.20	2.1 MB	4.7%	0.61
Oct 6 12:00:00 - 12:59:59	895	5.9%	0.25	2.5 MB	5.5%	0.70
Oct 6 13:00:00 - 13:59:59	959	6.3%	0.27	2.6 MB	5.8%	0.74
Oct 6 14:00:00 - 14:59:59	879	5.8%	0.24	2.4 MB	5.2%	0.68
Oct 6 15:00:00 - 15:59:59	901	6.0%	0.25	2.6 MB	5.7%	0.74
Oct 6 16:00:00 - 16:59:59	912	6.0%	0.25	3.6 MB	8.0%	1.03
Oct 6 17:00:00 - 17:59:59	842	5.6%	0.23	2.5 MB	5.5%	0.71
Oct 6 18:00:00 - 18:59:59	773	5.1%	0.21	2.1 MB	4.5%	0.59
Oct 6 19:00:00 - 19:59:59	709	4.7%	0.20	2.1 MB	4.6%	0.60
Oct 6 20:00:00 - 20:59:59	717	4.7%	0.20	2.1 MB	4.7%	0.60
Oct 6 21:00:00 - 21:59:59	658	4.4%	0.18	1.8 MB	3.9%	0.51
Oct 6 22:00:00 - 22:59:59	511	3.4%	0.14	1.4 MB	3.0%	0.39
Oct 6 23:00:00 - 23:59:59	467	3.1%	0.13	1.3 MB	2.9%	0.38
Oct 7 00:00:00 - 00:59:59	355	2.3%	0.10	913.2 KB	2.0%	0.25
Oct 7 01:00:00 - 01:59:59	405	2.7%	0.11	1.3 MB	2.8%	0.36
Oct 7 02:00:00 - 02:59:59	318	2.1%	0.09	1.0 MB	2.2%	0.29
Oct 7 03:00:00 - 03:59:59	308	2.0%	0.09	878.9 KB	1.9%	0.24
Oct 7 04:00:00 - 04:15:00	114	0.8%	0.13	746.7 KB	1.6%	0.83
TOTAL: 24:00:00	15116	100.0%	0.17	45.4 MB	100.0%	0.54

Sites sending bad articles:

Server		Total	Group	Duplic	Unapp	Other
1	csiph-out.news.xs4all.nl	7736	158	1	2	7575
2	newsfeed.neva.ru	1413	87	0	0	1326
3	news.freedyn.net	781	0	2	0	779
4	csiph-out.news.weretis.net	519	67	0	0	452
5	newsfeed.fu-berlin.de	506	21	0	0	485
6	news-out.mixmin.net	220	29	1	0	190
7	csiph-out.feed.uzoreto.com	155	16	0	0	139
8	csiph-out.feeder.erje.net	126	55	0	0	71
9	news-out.aioe.org	104	69	0	0	35
10	feeder.eternal-september.org	88	54	1	0	33
11	newsfeeds.xmission.com	35	5	3	0	27
12	news-out.neodome.net	34	3	2	0	29
13	nntp.pasdenom.info	33	0	0	0	33
14	csiph-out.news.tnetconsulting.net	21	18	0	0	3
15	news.fcku.it	14	13	0	0	1
16	news.swapon.de	10	0	0	0	10
17	news.samoylyk.net	5	0	0	0	5
TOTAL: 17		11800	595	10	2	11193

Unwanted newsgroups [Top 20]:

Newsgroup	Count
alt.hack.nl	100
lada.talk	67
alt.windows7.general	52
it-alt.sport.calcio.juventus	46
alt.computer.workshop	45
alt.bbs.synchronet	32
scinet.stats	29
alt.politics.usa	16
alt.politics	15
mozilla.support.seamonkey	13
alt.binaries.pictures.purebeauty	13
mozilla.support.thunderbird	12
alt.survival	12
alt.slack.goathead	12
trollnet.cinema	9
mozilla.dev.security.policy	9
alt.math.undergrad	7
alt.philosophy	7
cakewalk.audio	7
lada.auto	6
TOTAL: 64	595

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

Groups	Count
uk.legal.moderated	2
TOTAL: 1	2

INND Perl filter [Top 20]:

Reason	Count
Binary: misplaced binary	7633
EMP (md5)	1976
EMP (phn path)	563
EMP (phl)	196
Too many newsgroups	73
0	66
EMP (phn nph)	32
HTML Multipart	19
Scoring filter	12
Binary Payload	1
HTML post	1
TOTAL: 11	10572

Miscellaneous innd statistics [Top 10]:

Event	Server	Number
Bad Message-ID's offered
	csiph-out.feeder.erje.net	45
	TOTAL: 1	45
Huge articles
	csiph-out.feeder.erje.net	34
	csiph-out.news.xs4all.nl	33
	csiph-out.feed.uzoreto.com	32
	news-out.neodome.net	23
	newsfeeds.xmission.com	19
	news.freedyn.net	18
	feeder.eternal-september.org	7
	news.samoylyk.net	5
	csiph-out.news.weretis.net	3
	news-out.mixmin.net	1
	TOTAL: 12	177
Including strange strings
	newsfeed.fu-berlin.de	287
	news-out.mixmin.net	49
	csiph-out.news.xs4all.nl	42
	news-out.aioe.org	24
	csiph-out.news.weretis.net	13
	news.swapon.de	10
	newsfeeds.xmission.com	7
	newsfeed.neva.ru	2
	csiph-out.feeder.erje.net	2
	TOTAL: 9	436
No colon-space in header
	csiph-out.news.xs4all.nl	5
	csiph-out.feeder.erje.net	3
	TOTAL: 2	8
TOTAL: 4		666

Outgoing Feeds (innfeed) by Articles:

Server		Offered	Taken	Refused	Reject	Spool	%Took	Elapsed
1	xanadu-bbs	18847	1346	13753	17	65	7%	23:59:54
2	news.bbs.nz	28438	560	14082	13	0	1%	23:59:36
3	fu-berlin.de	14247	438	13809	0	0	3%	23:59:54
4	news.samoylyk.net	15550	423	14679	11	0	2%	23:59:45
5	tnet	16021	105	14555	1	2334	0%	23:59:54
6	news.freedyn.net	14795	37	14458	0	0	0%	23:59:51
7	neva.ru	13741	34	13457	148	0	0%	23:59:54
8	erje	15583	29	14270	34	0	0%	23:59:21
9	newsfeed.xs4all.nl	12232	27	11755	1	64	0%	23:59:54
10	usenet.pasdenom.info	15158	20	14518	2	43	0%	23:59:54
11	xmission	13573	18	10716	1	0	0%	23:59:36
12	news.mixmin.net	12893	17	12591	0	0	0%	23:59:54
13	weretis.net	14476	12	14101	0	0	0%	23:59:49
14	neodome.net	15329	11	14931	0	0	0%	23:59:53
15	aioe	10899	11	10463	1	0	0%	23:59:47
16	eternal-september	12806	9	12494	1	0	0%	23:59:54
17	news.swapon.de	1156	8	1136	0	0	0%	23:29:56
18	news.uzoreto.com	14094	5	13789	17	0	0%	23:59:54
19	news.fcku.it	1394	0	1392	0	0	0%	21:40:18
TOTAL: 19		261232	3110	230949	247	2506	1%	453:06:58

Outgoing Feeds (innfeed) by Volume:

Server		AcceptVol	RejectVol	TotalVol	Volume/sec	Vol/Art	Elapsed
1	xanadu-bbs	7.0 MB	51.5 KB	7.0 MB	0.1 KB/s	5.3 KB	23:59:54
2	fu-berlin.de	4.1 MB	0.0 KB	4.1 MB	0.0 KB/s	9.5 KB	23:59:54
3	news.samoylyk.net	3.9 MB	131.4 KB	4.1 MB	0.0 KB/s	9.6 KB	23:59:45
4	news.bbs.nz	1.5 MB	70.7 KB	1.5 MB	0.0 KB/s	2.7 KB	23:59:36
5	news.freedyn.net	420.2 KB	0.0 KB	420.2 KB	0.0 KB/s	11.4 KB	23:59:51
6	tnet	194.1 KB	3.9 KB	198.0 KB	0.0 KB/s	1.9 KB	23:59:54
7	erje	55.9 KB	295.0 KB	350.9 KB	0.0 KB/s	5.6 KB	23:59:21
8	neva.ru	53.3 KB	275.6 KB	328.9 KB	0.0 KB/s	1.8 KB	23:59:54
9	newsfeed.xs4all.nl	46.3 KB	1.9 KB	48.2 KB	0.0 KB/s	1.7 KB	23:59:54
10	xmission	44.4 KB	1.3 KB	45.7 KB	0.0 KB/s	2.4 KB	23:59:36
11	usenet.pasdenom.info	40.3 KB	4.7 KB	45.0 KB	0.0 KB/s	2.0 KB	23:59:54
12	news.mixmin.net	27.5 KB	0.0 KB	27.5 KB	0.0 KB/s	1.6 KB	23:59:54
13	weretis.net	25.7 KB	0.0 KB	25.7 KB	0.0 KB/s	2.1 KB	23:59:49
14	aioe	22.0 KB	3.9 KB	25.9 KB	0.0 KB/s	2.2 KB	23:59:47
15	neodome.net	18.0 KB	0.0 KB	18.0 KB	0.0 KB/s	1.6 KB	23:59:53
16	eternal-september	15.1 KB	0.8 KB	15.9 KB	0.0 KB/s	1.6 KB	23:59:54
17	news.swapon.de	13.3 KB	0.0 KB	13.3 KB	0.0 KB/s	1.7 KB	23:29:56
18	news.uzoreto.com	8.8 KB	26.4 KB	35.2 KB	0.0 KB/s	1.6 KB	23:59:54
19	news.fcku.it	0.0 KB	0.0 KB	0.0 KB	0.0 KB/s	0	21:40:18
TOTAL: 19		17.4 MB	867.0 KB	18.3 MB	0.0 KB/s	5.6 KB	453:06:58

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed
1	096-042-018-108.res.spectrum.com	22	16	25.5 KB	12	8	6	07:07:13
2	a131033.upc-a.chello.nl	57	12	17.5 KB	6	0	0	14:30:33
3	p2e5b5fdf.dip0.t-ipconnect.de	1	1	1.6 KB	1	0	0	00:00:06
TOTAL: 3		80	29	44.6 KB	19	8	6	47:23:39

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed
1	*.res.spectrum.com	22	16	25.5 KB	12	8	6	07:07:13
2	*.upc-a.chello.nl	57	12	17.5 KB	6	0	0	14:30:33
3	*.dip0.t-ipconnect.de	1	1	1.6 KB	1	0	0	00:00:06
4	*.w82-125.abo.wanadoo.fr	1	0	0.0 KB	0	0	0	00:00:02
5	*.w90-20.abo.wanadoo.fr	1	0	0.0 KB	0	0	0	00:00:01
6	*.ph.ph.cox.net	9	0	0.0 KB	0	0	0	04:24:14
7	*.home.otenet.gr	1	0	0.0 KB	0	0	0	00:00:01
8	unresolved	55	0	0.0 KB	0	0	0	17:31:19
9	*.net.upcbroadband.cz	11	0	0.0 KB	0	0	0	03:50:05
TOTAL: 9		158	29	44.6 KB	19	8	6	47:23:39

NNRP auth users [Top 20]:

User	Conn
ohlandl	6
TOTAL: 1	6

NNRP total resource statistics [Top 20]:

System	User(ms)	System(ms)	Idle(ms)	Elapsed
91.187.33.87	3.755	0.845	0.000	17:31:18
a131033.upc-a.chello.nl	4.247	0.874	0.000	14:30:33
096-042-018-108.res.spectrum.com	1.723	0.405	0.016	07:07:13
ip72-222-200-117.ph.ph.cox.net	0.893	0.143	0.000	04:24:14
ip-78-102-198-192.net.upcbroadband.cz	0.774	0.178	0.000	03:50:05
p2e5b5fdf.dip0.t-ipconnect.de	0.102	0.047	0.000	00:00:06
lfbn-poi-1-714-63.w82-125.abo.wanadoo.fr	0.348	1.407	0.000	00:00:02
aorleans-654-1-9-62.w90-20.abo.wanadoo.fr	0.063	0.018	0.000	00:00:01
ppp-2-84-172-192.home.otenet.gr	0.066	0.016	0.000	00:00:01
8.12.22.245	0.056	0.024	0.000	00:00:00
193.142.146.50	0.070	0.008	0.000	00:00:00
TOTAL: 11	12.097	3.965	0.016	47:23:39

Curious NNRP server explorers [Top 20]:

System	Conn
91.187.33.87	53
ip-78-102-198-192.net.upcbroadband.cz	11
ip72-222-200-117.ph.ph.cox.net	9
lfbn-poi-1-714-63.w82-125.abo.wanadoo.fr	1
8.12.22.245	1
193.142.146.50	1
aorleans-654-1-9-62.w90-20.abo.wanadoo.fr	1
ppp-2-84-172-192.home.otenet.gr	1
TOTAL: 8	78

NNRP unrecognized commands (by host):

System	Conn
8.12.22.245	6
193.142.146.50	1
TOTAL: 2	7

NNRP unrecognized commands (by command):

Command	Count
User-Agent: Mozilla/5.0 (Macintosh; Inte...	1
^C	1
Host: 69.160.37.58:119	1
Accept: text/html,application/xhtml+xml,...	1
GET / HTTP/1.1	1
Accept-Encoding: gzip, deflate	1
Connection: keep-alive	1
TOTAL: 7	7

NNRP client timeouts [Top 20]:

System	Conn	Peer
096-042-018-108.res.spectrum.com	8	0
ip72-222-200-117.ph.ph.cox.net	7	0
91.187.33.87	1	0
193.142.146.50	1	1
ip-78-102-198-192.net.upcbroadband.cz	1	0
TOTAL: 5	18	1

Newsgroup request counts (by category):

Category		Count	Pct
1	comp	28	96.6%
2	de	1	3.4%
TOTAL: 2		29	100.0%

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

Newsgroup		Count
1	comp.sys.ibm.ps2.hardware	28
2	de.sci.electronics	1
TOTAL: 2		29

Daily Usenet report for csiph.com

Oct 6 04:15:00 -- Oct 7 04:15:00