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

Log entries by program:

Program name	Lines	%Lines	Size	%Size
inn	20585	50.4%	5.2 MB	65.1%
innd	15666	38.4%	2.1 MB	25.9%
innfeed	3514	8.6%	621.7 KB	7.6%
nnrpd	1028	2.5%	113.0 KB	1.4%
nocem	21	0.1%	2.8 KB	0.0%
controlchan	1	0.0%	0.1 KB	0.0%
TOTAL: 6	40815	100.0%	8.0 MB	100.0%

History cache:

Reason	Count	%Count
Positive hits	335848	56.6%
Negative hits	236851	39.9%
Do not exist	19644	3.3%
Cache misses	695	0.1%
TOTAL: 4	593038	100.0%

INND timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article cancel	00:00:04.997	0.0%	320	0.000	15.616	37.000
article cleanup	00:00:00.142	0.0%	19474	0.000	0.007	0.035
article logging	00:00:00.627	0.0%	19952	0.000	0.031	0.514
article parse	00:00:00.942	0.0%	56117	0.000	0.017	0.096
article write	00:00:58.309	0.1%	16257	0.377	3.587	34.795
artlog/artcncl	00:00:00.003	0.0%	320	0.000	0.009	0.010
artlog/artparse	00:00:00.012	0.0%	327	0.000	0.037	1.125
data move	00:00:00.186	0.0%	556919	0.000	0.000	0.002
hisgrep/artcncl	00:00:00.174	0.0%	319	0.000	0.545	18.000
hishave/artcncl	00:00:00.032	0.0%	320	0.000	0.100	1.000
hishave/artparse	00:00:00.001	0.0%	314	0.000	0.003	0.083
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	00:00:25.011	0.0%	596548	0.001	0.042	0.197
history sync	00:00:00.949	0.0%	365	0.000	2.600	29.000
history write	00:00:34.188	0.0%	19469	0.415	1.756	6.244
hiswrite/artcncl	00:00:00.001	0.0%	1	1.000	1.000	1.000
hiswrite/artparse	00:00:00.449	0.0%	314	0.000	1.430	17.000
idle	23:53:23.886	99.5%	555275	85.141	154.885	488.624
nntp read	00:00:02.219	0.0%	564201	0.002	0.004	0.008
overview write	00:04:16.763	0.3%	16257	0.104	15.794	2107.157
perl filter	00:00:27.365	0.0%	19456	1.110	1.407	2.249
python filter	00:00:00.000	0.0%	0	0.000	0.000	0.000
site send	00:00:00.252	0.0%	32534	0.000	0.008	0.022
TOTAL: 24:00:59.468	24:00:16.508	100.0%	-	-	-	-

INNfeed timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article new	00:00:00.024	0.0%	17703	0.000	0.001	0.018
article prepare	00:00:00.002	0.0%	13468	0.000	0.000	0.017
article read	00:00:01.370	0.0%	1516	0.000	0.904	44.125
backlog stats	00:00:00.253	0.0%	377476	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.420	0.0%	296036	0.001	0.005	0.010
data write	00:00:01.656	0.0%	282957	0.002	0.006	0.011
idle	23:54:12.009	100.0%	377476	118.351	227.967	581.106
status file	00:00:00.318	0.0%	294	0.000	1.082	23.000
TOTAL: 23:54:23.238	23:54:17.052	100.0%	-	-	-	-

nnrpd timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
idle	41:37:43.361	99.9%	809	153.000	185245.193	600093.667
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:00:00.018	0.0%	1899	0.000	0.009	0.182
readart	00:00:00.464	0.0%	86	0.000	5.395	42.000
TOTAL: 41:41:27.233	41:37:43.843	99.9%	-	-	-	-

Control commands to INND:

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

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed
1	newsfeeds.xmission.com	3	15648	3920	11697	31	25%	24:19:03
2	csiph-out.news.xs4all.nl	411	19056	2622	14788	1646	13%	69:10:57
3	feeder.eternal-september.org	1	19687	2451	17111	125	12%	26:28:33
4	news-out.mixmin.net	3	17429	2366	14837	226	13%	24:11:58
5	news-out.aioe.org	2	15726	1307	14298	121	8%	24:09:01
6	newsfeed.fu-berlin.de	13	14295	759	13365	171	5%	22:52:48
7	newsfeed.neva.ru	153	15800	664	14823	313	4%	72:07:38
8	csiph-out.feeder.erje.net	1440	80727	629	79977	121	0%	118:41:17
9	csiph-out.news.weretis.net	4	34633	617	33689	327	1%	50:38:10
10	news.fcku.it	12	2057	347	1706	4	16%	22:21:19
11	csiph-out.feed.uzoreto.com	864	25740	229	25131	380	0%	71:16:55
12	news-out.neodome.net	1	17797	166	17609	22	0%	23:59:54
13	nntp.pasdenom.info	7	10741	97	10613	31	0%	25:25:35
14	news.swapon.de	9	1446	56	1390	0	3%	22:22:35
15	csiph-out.news.tnetconsulting.net	2	16449	48	16367	34	0%	23:59:42
16	news.freedyn.net	1	19650	25	19572	53	0%	23:59:57
17	localhost	42	16	16	0	0	100%	00:00:04
18	news.bbs.nz	2	16010	12	15998	0	0%	23:59:53
19	news.samoylyk.net	5	15746	2	15743	1	0%	24:48:24
20	xanadu-bbs.net	30	387	1	385	1	0%	19:28:11
TOTAL: 20		3005	359040	16334	339099	3607	4%	714:21:54

Incoming Volume (INN):

Server		AcceptVol	DupVol	RejVol	TotalVol	%Acc	Vol/Art
1	newsfeeds.xmission.com	12.3 MB	0.0 KB	1.3 MB	13.6 MB	90%	3.5 KB
2	csiph-out.news.xs4all.nl	6.9 MB	1.5 KB	10.7 MB	17.6 MB	39%	4.2 KB
3	feeder.eternal-september.org	6.5 MB	8.5 KB	918.3 KB	7.4 MB	87%	2.9 KB
4	news-out.mixmin.net	4.6 MB	7.4 KB	487.9 KB	5.1 MB	90%	2.0 KB
5	news-out.aioe.org	4.5 MB	2.1 KB	305.4 KB	4.8 MB	93%	3.5 KB
6	csiph-out.feeder.erje.net	3.8 MB	33.8 KB	2.7 MB	6.5 MB	58%	8.8 KB
7	csiph-out.news.weretis.net	1.7 MB	0.0 KB	1.1 MB	2.8 MB	60%	3.1 KB
8	newsfeed.neva.ru	1.6 MB	0.0 KB	769.8 KB	2.4 MB	68%	2.5 KB
9	newsfeed.fu-berlin.de	1.6 MB	0.0 KB	386.9 KB	2.0 MB	81%	2.2 KB
10	csiph-out.feed.uzoreto.com	1.2 MB	0.0 KB	6.8 MB	8.0 MB	14%	13.4 KB
11	news.fcku.it	548.8 KB	0.0 KB	5.7 KB	554.5 KB	98%	1.6 KB
12	news-out.neodome.net	468.8 KB	0.0 KB	964.3 KB	1.4 MB	32%	7.6 KB
13	nntp.pasdenom.info	249.0 KB	0.0 KB	39.9 KB	288.9 KB	86%	2.3 KB
14	news.freedyn.net	238.0 KB	0.0 KB	1.9 MB	2.1 MB	10%	27.9 KB
15	csiph-out.news.tnetconsulting.net	190.4 KB	0.0 KB	217.3 KB	407.6 KB	46%	5.0 KB
16	news.swapon.de	128.1 KB	0.0 KB	0.0 KB	128.1 KB	100%	2.3 KB
17	localhost	22.7 KB	0.0 KB	0.0 KB	22.7 KB	100%	1.4 KB
18	news.bbs.nz	19.7 KB	0.0 KB	0.0 KB	19.7 KB	100%	1.6 KB
19	news.samoylyk.net	4.5 KB	0.0 KB	52.4 KB	56.9 KB	7%	19.0 KB
20	xanadu-bbs.net	2.4 KB	0.0 KB	69.1 KB	71.5 KB	3%	35.8 KB
TOTAL: 20		46.6 MB	53.3 KB	28.6 MB	75.2 MB	61%	3.9 KB

Incoming articles:

Date	Articles	%Arts	Art/sec	Size	%Size	KB/sec
Oct 2 04:15:00 - 04:59:59	553	3.4%	0.20	2.5 MB	5.3%	0.94
Oct 2 05:00:00 - 05:59:59	389	2.4%	0.11	1.2 MB	2.6%	0.34
Oct 2 06:00:00 - 06:59:59	476	2.9%	0.13	1.2 MB	2.7%	0.35
Oct 2 07:00:00 - 07:59:59	626	3.9%	0.17	1.6 MB	3.4%	0.45
Oct 2 08:00:00 - 08:59:59	710	4.4%	0.20	2.0 MB	4.3%	0.57
Oct 2 09:00:00 - 09:59:59	797	4.9%	0.22	2.1 MB	4.4%	0.59
Oct 2 10:00:00 - 10:59:59	721	4.4%	0.20	1.8 MB	3.9%	0.51
Oct 2 11:00:00 - 11:59:59	689	4.2%	0.19	1.8 MB	4.0%	0.52
Oct 2 12:00:00 - 12:59:59	854	5.3%	0.24	2.4 MB	5.1%	0.68
Oct 2 13:00:00 - 13:59:59	1037	6.4%	0.29	2.7 MB	5.9%	0.78
Oct 2 14:00:00 - 14:59:59	915	5.6%	0.25	2.4 MB	5.2%	0.68
Oct 2 15:00:00 - 15:59:59	963	5.9%	0.27	2.8 MB	6.0%	0.79
Oct 2 16:00:00 - 16:59:59	959	5.9%	0.27	2.5 MB	5.4%	0.71
Oct 2 17:00:00 - 17:59:59	878	5.4%	0.24	2.4 MB	5.3%	0.69
Oct 2 18:00:00 - 18:59:59	868	5.3%	0.24	2.2 MB	4.8%	0.64
Oct 2 19:00:00 - 19:59:59	892	5.5%	0.25	3.2 MB	6.8%	0.90
Oct 2 20:00:00 - 20:59:59	769	4.7%	0.21	2.1 MB	4.4%	0.59
Oct 2 21:00:00 - 21:59:59	651	4.0%	0.18	1.7 MB	3.7%	0.49
Oct 2 22:00:00 - 22:59:59	570	3.5%	0.16	1.7 MB	3.7%	0.48
Oct 2 23:00:00 - 23:59:59	457	2.8%	0.13	1.3 MB	2.8%	0.37
Oct 3 00:00:00 - 00:59:59	389	2.4%	0.11	1.2 MB	2.5%	0.34
Oct 3 01:00:00 - 01:59:59	348	2.1%	0.10	1.2 MB	2.7%	0.35
Oct 3 02:00:00 - 02:59:59	335	2.1%	0.09	1019.9 KB	2.2%	0.28
Oct 3 03:00:00 - 03:59:59	305	1.9%	0.08	1.1 MB	2.3%	0.30
Oct 3 04:00:00 - 04:15:00	95	0.6%	0.11	270.4 KB	0.6%	0.30
TOTAL: 24:00:00	16246	100.0%	0.19	46.3 MB	100.0%	0.55

Sites sending bad articles:

Server		Total	Group	Duplic	Other
1	csiph-out.news.xs4all.nl	1670	71	1	1598
2	newsfeed.fu-berlin.de	552	27	0	525
3	csiph-out.feed.uzoreto.com	381	10	0	371
4	newsfeed.neva.ru	315	51	0	264
5	news-out.mixmin.net	281	19	2	260
6	csiph-out.news.weretis.net	256	34	0	222
7	news-out.aioe.org	132	105	1	26
8	csiph-out.feeder.erje.net	122	29	11	82
9	feeder.eternal-september.org	120	64	3	53
10	news.freedyn.net	50	0	0	50
11	newsfeeds.xmission.com	42	8	0	34
12	nntp.pasdenom.info	31	0	0	31
13	csiph-out.news.tnetconsulting.net	27	22	0	5
14	news-out.neodome.net	22	1	0	21
15	news.swapon.de	13	0	0	13
16	news.fcku.it	4	4	0	0
17	news.samoylyk.net	1	0	0	1
18	xanadu-bbs.net	1	0	0	1
TOTAL: 18		4020	445	18	3557

Unwanted newsgroups [Top 20]:

Newsgroup	Count
alt.computer.workshop	83
alt.bbs.synchronet	72
lada.talk	32
scinet.stats	19
alt.politics	18
it-alt.sport.calcio.juventus	16
alt.politics.usa	16
alt.survival	16
lada.auto	11
alt.binaries.pictures.purebeauty	10
mozilla.support.thunderbird	10
alt.windows7.general	9
abg.test	8
alt.slack.goathead	8
alt.job	8
spline.eisfair	8
mozilla.support.firefox	7
at.jobs	7
att.jobs	6
free.it.religioni.scientology	6
TOTAL: 65	445

INND Perl filter [Top 20]:

Reason	Count
EMP (md5)	1863
EMP (phn path)	402
EMP (phl)	199
Too many newsgroups	117
0	77
EMP (phn nph)	56
HTML Multipart	19
Scoring filter	15
Binary: misplaced binary	4
Too many newsgroups (meow)	1
TOTAL: 10	2753

Miscellaneous innd statistics [Top 10]:

Event	Server	Number
Bad Message-ID's offered
	csiph-out.feeder.erje.net	75
	csiph-out.news.xs4all.nl	6
	csiph-out.feed.uzoreto.com	6
	TOTAL: 3	87
Huge articles
	csiph-out.news.xs4all.nl	89
	csiph-out.feed.uzoreto.com	85
	csiph-out.feeder.erje.net	45
	news.freedyn.net	34
	news-out.neodome.net	19
	newsfeeds.xmission.com	19
	feeder.eternal-september.org	9
	csiph-out.news.weretis.net	5
	csiph-out.news.tnetconsulting.net	3
	news-out.mixmin.net	2
	TOTAL: 13	313
Including strange strings
	newsfeed.fu-berlin.de	350
	news-out.mixmin.net	58
	csiph-out.news.xs4all.nl	25
	news-out.aioe.org	13
	news.swapon.de	13
	newsfeeds.xmission.com	11
	csiph-out.news.weretis.net	5
	csiph-out.feeder.erje.net	2
	csiph-out.feed.uzoreto.com	1
	TOTAL: 9	478
No colon-space in header
	csiph-out.news.xs4all.nl	13
	TOTAL: 1	13
TOTAL: 4		891

Outgoing Feeds (innfeed) by Articles:

Server		Offered	Taken	Refused	Reject	Spool	%Took	Elapsed
1	xanadu-bbs	20381	1028	15174	43	81	5%	23:59:56
2	news.bbs.nz	29586	440	15308	29	0	1%	23:56:38
3	fu-berlin.de	15203	438	14765	0	0	2%	23:59:56
4	news.samoylyk.net	16723	415	15784	11	475	2%	23:49:34
5	tnet	17140	149	15586	0	0	0%	23:50:04
6	neva.ru	14859	143	14469	91	0	0%	23:59:53
7	newsfeed.xs4all.nl	14008	77	13438	4	0	0%	23:52:49
8	news.freedyn.net	16032	65	15604	0	0	0%	23:59:50
9	erje	17562	55	15372	82	0	0%	23:59:56
10	usenet.pasdenom.info	16592	34	15646	34	918	0%	23:59:56
11	news.mixmin.net	13673	31	13246	0	0	0%	23:59:56
12	neodome.net	16576	21	16038	0	0	0%	23:58:22
13	eternal-september	13624	21	13248	0	0	0%	23:59:56
14	news.uzoreto.com	15437	20	15062	64	0	0%	23:50:04
15	xmission	14934	20	11852	1	0	0%	23:59:47
16	aioe	11982	18	11399	1	0	0%	23:48:53
17	news.swapon.de	1537	16	1498	0	0	1%	23:34:13
18	weretis.net	15158	16	14822	0	0	0%	23:50:04
19	news.fcku.it	1666	0	1664	0	0	0%	21:28:31
TOTAL: 19		282673	3007	249975	360	1474	1%	451:58:18

Outgoing Feeds (innfeed) by Volume:

Server		AcceptVol	RejectVol	TotalVol	Volume/sec	Vol/Art	Elapsed
1	xanadu-bbs	5.2 MB	119.4 KB	5.3 MB	0.1 KB/s	5.1 KB	23:59:56
2	fu-berlin.de	3.4 MB	0.0 KB	3.4 MB	0.0 KB/s	8.0 KB	23:59:56
3	news.samoylyk.net	3.2 MB	109.7 KB	3.3 MB	0.0 KB/s	8.0 KB	23:49:34
4	news.bbs.nz	1.0 MB	144.9 KB	1.2 MB	0.0 KB/s	2.6 KB	23:56:38
5	news.freedyn.net	439.4 KB	0.0 KB	439.4 KB	0.0 KB/s	6.8 KB	23:59:50
6	neva.ru	275.6 KB	250.6 KB	526.2 KB	0.0 KB/s	2.2 KB	23:59:53
7	tnet	272.6 KB	0.0 KB	272.6 KB	0.0 KB/s	1.8 KB	23:50:04
8	usenet.pasdenom.info	188.5 KB	141.5 KB	330.0 KB	0.0 KB/s	4.9 KB	23:59:56
9	newsfeed.xs4all.nl	147.1 KB	45.5 KB	192.5 KB	0.0 KB/s	2.4 KB	23:52:49
10	erje	107.9 KB	290.9 KB	398.8 KB	0.0 KB/s	2.9 KB	23:59:56
11	news.mixmin.net	88.9 KB	0.0 KB	88.9 KB	0.0 KB/s	2.9 KB	23:59:56
12	eternal-september	64.9 KB	0.0 KB	64.9 KB	0.0 KB/s	3.1 KB	23:59:56
13	news.swapon.de	55.6 KB	0.0 KB	55.6 KB	0.0 KB/s	3.5 KB	23:34:13
14	neodome.net	37.4 KB	0.0 KB	37.4 KB	0.0 KB/s	1.8 KB	23:58:22
15	news.uzoreto.com	33.9 KB	233.9 KB	267.8 KB	0.0 KB/s	3.2 KB	23:50:04
16	xmission	30.9 KB	2.0 KB	32.9 KB	0.0 KB/s	1.6 KB	23:59:47
17	aioe	25.7 KB	1.2 KB	26.9 KB	0.0 KB/s	1.4 KB	23:48:53
18	weretis.net	22.7 KB	0.0 KB	22.7 KB	0.0 KB/s	1.4 KB	23:50:04
19	news.fcku.it	0.0 KB	0.0 KB	0.0 KB	0.0 KB/s	0	21:28:31
TOTAL: 19		14.6 MB	1.3 MB	15.9 MB	0.0 KB/s	4.8 KB	451:58:18

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed
1	096-042-018-108.res.spectrum.com	38	24	49.7 KB	23	16	13	08:16:45
2	ip72-222-200-117.ph.ph.cox.net	5	23	54.7 KB	28	0	0	03:08:37
3	a131033.upc-a.chello.nl	26	23	54.5 KB	5	0	0	06:55:24
4	ppp-2-84-172-192.home.otenet.gr	2	16	35.6 KB	1	0	0	00:00:11
TOTAL: 4		71	86	194.5 KB	57	16	13	41:41:26

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed
1	*.res.spectrum.com	38	24	49.7 KB	23	16	13	08:16:45
2	*.ph.ph.cox.net	5	23	54.7 KB	28	0	0	03:08:37
3	*.upc-a.chello.nl	26	23	54.5 KB	5	0	0	06:55:24
4	*.home.otenet.gr	2	16	35.6 KB	1	0	0	00:00:11
5	*.net.upcbroadband.cz	19	0	0.0 KB	0	0	0	06:05:56
6	unresolved	56	0	0.0 KB	0	0	0	17:14:30
TOTAL: 6		146	86	194.5 KB	57	16	13	41:41:26

NNRP auth users [Top 20]:

User	Conn
ohlandl	13
TOTAL: 1	13

NNRP total resource statistics [Top 20]:

System	User(ms)	System(ms)	Idle(ms)	Elapsed
91.187.33.87	3.739	0.813	0.000	17:14:18
096-042-018-108.res.spectrum.com	3.277	0.627	0.031	08:16:45
a131033.upc-a.chello.nl	1.894	0.421	0.000	06:55:24
ip-78-102-198-192.net.upcbroadband.cz	1.359	0.283	0.000	06:05:56
ip72-222-200-117.ph.ph.cox.net	0.705	0.117	0.000	03:08:37
ppp-2-84-172-192.home.otenet.gr	0.149	0.049	0.000	00:00:11
188.166.238.7	0.117	0.039	0.000	00:00:09
151.82.153.124	0.068	0.009	0.000	00:00:01
89.248.168.176	0.053	0.026	0.000	00:00:00
TOTAL: 9	11.361	2.384	0.031	41:41:26

Curious NNRP server explorers [Top 20]:

System	Conn
91.187.33.87	52
ip-78-102-198-192.net.upcbroadband.cz	19
188.166.238.7	2
151.82.153.124	1
89.248.168.176	1
TOTAL: 5	75

NNRP client timeouts [Top 20]:

System	Conn	Peer
096-042-018-108.res.spectrum.com	9	0
ip72-222-200-117.ph.ph.cox.net	6	0
TOTAL: 2	15	0

Newsgroup request counts (by category):

Category		Count	Pct
1	comp	91	100.0%
TOTAL: 1		91	100.0%

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

Newsgroup		Count
1	comp.sys.ibm.ps2.hardware	90
2	comp.unix.aix	1
TOTAL: 2		91

Daily Usenet report for csiph.com

Oct 2 04:15:00 -- Oct 3 04:15:00