Daily Usenet report for csiph.com: Nov 29 04:15:00

Log entries by program:

Program name	Lines	%Lines	Size	%Size
inn	49409	45.5%	7.2 MB	57.0%
nnrpd	32194	29.7%	2.7 MB	21.4%
innd	24937	23.0%	2.4 MB	19.2%
innfeed	1983	1.8%	318.7 KB	2.5%
controlchan	7	0.0%	1.1 KB	0.0%
TOTAL: 5	108530	100.0%	12.6 MB	100.0%

History cache:

Reason	Count	%Count
Positive hits	221370	46.0%
Negative hits	209852	43.7%
Do not exist	48764	10.1%
Cache misses	751	0.2%
TOTAL: 4	480737	100.0%

INND timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article cancel	00:00:00.681	0.0%	240	0.000	2.837	134.000
article cleanup	00:00:00.260	0.0%	40324	0.000	0.006	0.025
article logging	00:00:00.526	0.0%	40786	0.000	0.013	0.057
article parse	00:00:17.299	0.0%	1229383	0.003	0.014	0.364
article write	00:01:25.154	0.1%	22175	0.186	3.840	9.424
artlog/artcncl	00:00:00.002	0.0%	144	0.000	0.014	0.125
artlog/artparse	00:00:00.108	0.0%	8481	0.000	0.013	0.500
data move	00:00:01.056	0.0%	1632267	0.000	0.001	0.002
hisgrep/artcncl	00:00:00.119	0.0%	232	0.000	0.513	79.000
hishave/artcncl	00:00:00.002	0.0%	240	0.000	0.008	0.125
hishave/artparse	00:00:00.026	0.0%	8481	0.000	0.003	0.059
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	00:00:04.058	0.0%	472710	0.001	0.009	0.152
history sync	00:00:02.312	0.0%	348	0.000	6.644	87.000
history write	00:00:47.326	0.1%	40317	0.035	1.174	14.703
hiswrite/artcncl	00:00:00.000	0.0%	8	0.000	0.000	0.000
hiswrite/artparse	00:00:07.627	0.0%	8480	0.000	0.899	32.500
idle	23:55:04.026	99.6%	1594038	8.629	54.016	487.794
nntp read	00:00:04.916	0.0%	1598049	0.001	0.003	0.007
overview write	00:01:03.017	0.1%	22175	0.381	2.842	23.288
perl filter	00:01:12.533	0.1%	40317	0.900	1.799	3.266
python filter	00:00:00.000	0.0%	0	0.000	0.000	0.000
site send	00:00:00.379	0.0%	44353	0.000	0.009	0.031
TOTAL: 24:00:50.011	24:00:11.427	100.0%	-	-	-	-

INNfeed timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article new	00:00:00.075	0.0%	21684	0.000	0.003	0.024
article prepare	00:00:00.002	0.0%	4844	0.000	0.000	0.050
article read	00:00:00.325	0.0%	1035	0.000	0.314	16.000
backlog stats	00:00:00.085	0.0%	239852	0.000	0.000	0.002
callbacks	00:00:00.000	0.0%	0	0.000	0.000	0.000
data read	00:00:01.060	0.0%	185530	0.000	0.006	0.013
data write	00:00:01.249	0.0%	166023	0.001	0.008	0.019
idle	23:34:01.299	100.0%	239852	180.876	353.724	889.711
status file	00:00:00.079	0.0%	183	0.000	0.432	1.000
TOTAL: 23:34:09.899	23:34:04.174	100.0%	-	-	-	-

nnrpd timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
hisgrep	00:00:01.544	0.0%	15484	0.000	0.100	0.830
idle	63:52:59.825	99.7%	46802	0.000	4913.889	600154.000
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:00:00.589	0.0%	94652	0.000	0.006	0.333
readart	00:00:00.017	0.0%	76	0.000	0.224	4.000
TOTAL: 64:03:25.026	63:53:01.975	99.7%	-	-	-	-

Control commands to INND:

Command	Number
L	1
flush	4
flushlogs	2
go	2
logmode	2
mode	146
newgroup	3
pause	2
paused	2
reload	2
reserve	2
TOTAL: 11	168

Newsgroups created:

Group	Mode
free.shqip.muzike	y
free.shqip.politike	y
free.shqip.sport	y
TOTAL	3

Control Channel:

Sender	newgroup	rmgroup	Other	Bad PGP	DoIt	OK
y.m@gmx.com	3	0	0	0	3	3
TOTAL	3	0	0	0	3	3

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed
1	feeder.eternal-september.org	6	35626	5376	28268	1982	15%	23:53:54
2	au2pb.net	6	24336	4496	19008	832	18%	23:53:28
3	news-out.mixmin.net	7	29194	4228	20396	4570	14%	24:26:33
4	xanadu-bbs.net	6	48595	2558	31916	14121	5%	39:13:17
5	newsfeeds.xmission.com	7	22140	2197	19787	156	9%	23:41:13
6	newsfeed.neva.ru	155	48638	1488	42638	4512	3%	71:58:43
7	newsfeed.fu-berlin.de	26	25099	1203	23669	227	4%	24:46:23
8	news.swapon.de	3	1956	187	1751	18	9%	23:47:45
9	nntp.pasdenom.info	8	23158	156	22933	69	0%	24:16:33
10	localhost	26	0	0	0	0	0%	00:00:01
TOTAL: 10		250	258742	21889	210366	26487	8%	279:57:50

Incoming Volume (INN):

Server		AcceptVol	DupVol	RejVol	TotalVol	%Acc	Vol/Art
1	news-out.mixmin.net	14.7 MB	0.0 KB	8.0 MB	22.7 MB	64%	2.6 KB
2	feeder.eternal-september.org	14.7 MB	0.0 KB	12.6 MB	27.3 MB	53%	3.8 KB
3	au2pb.net	11.8 MB	0.0 KB	5.6 MB	17.4 MB	68%	3.3 KB
4	xanadu-bbs.net	6.9 MB	0.0 KB	1.9 GB	1.9 GB	0%	117.3 KB
5	newsfeeds.xmission.com	6.6 MB	0.0 KB	4.3 MB	10.9 MB	60%	4.8 KB
6	newsfeed.neva.ru	4.8 MB	126.2 KB	29.6 MB	34.5 MB	13%	5.9 KB
7	newsfeed.fu-berlin.de	2.7 MB	0.0 KB	526.0 KB	3.2 MB	83%	2.3 KB
8	news.swapon.de	456.7 KB	0.0 KB	61.1 KB	517.7 KB	88%	2.5 KB
9	nntp.pasdenom.info	450.7 KB	0.0 KB	1.4 MB	1.8 MB	24%	8.3 KB
10	localhost	0.0 KB	0.0 KB	0.0 KB	0.0 KB	0%	0
TOTAL: 10		63.1 MB	126.2 KB	1.9 GB	2.0 GB	3%	43.0 KB

Incoming articles:

Date	Articles	%Arts	Art/sec	Size	%Size	KB/sec
Nov 29 04:15:00 - 04:59:59	374	1.7%	0.14	1001.3 KB	1.5%	0.37
Nov 29 05:00:00 - 05:59:59	454	2.0%	0.13	1.3 MB	2.1%	0.37
Nov 29 06:00:00 - 06:59:59	403	1.8%	0.11	1.3 MB	2.0%	0.37
Nov 29 07:00:00 - 07:59:59	599	2.7%	0.17	1.7 MB	2.7%	0.50
Nov 29 08:00:00 - 08:59:59	737	3.3%	0.20	1.9 MB	3.0%	0.55
Nov 29 09:00:00 - 09:59:59	917	4.1%	0.25	2.6 MB	4.1%	0.75
Nov 29 10:00:00 - 10:59:59	1009	4.5%	0.28	2.8 MB	4.4%	0.81
Nov 29 11:00:00 - 11:59:59	1012	4.6%	0.28	2.9 MB	4.5%	0.82
Nov 29 12:00:00 - 12:59:59	1145	5.2%	0.32	3.3 MB	5.1%	0.93
Nov 29 13:00:00 - 13:59:59	1115	5.0%	0.31	2.7 MB	4.3%	0.78
Nov 29 14:00:00 - 14:59:59	1085	4.9%	0.30	3.0 MB	4.7%	0.86
Nov 29 15:00:00 - 15:59:59	1198	5.4%	0.33	3.8 MB	6.0%	1.09
Nov 29 16:00:00 - 16:59:59	1350	6.1%	0.38	3.8 MB	5.9%	1.07
Nov 29 17:00:00 - 17:59:59	1384	6.2%	0.38	4.1 MB	6.4%	1.16
Nov 29 18:00:00 - 18:59:59	1236	5.6%	0.34	3.4 MB	5.4%	0.98
Nov 29 19:00:00 - 19:59:59	1368	6.2%	0.38	4.2 MB	6.6%	1.20
Nov 29 20:00:00 - 20:59:59	1231	5.6%	0.34	3.2 MB	4.9%	0.90
Nov 29 21:00:00 - 21:59:59	1105	5.0%	0.31	2.8 MB	4.4%	0.80
Nov 29 22:00:00 - 22:59:59	1172	5.3%	0.33	3.3 MB	5.1%	0.93
Nov 29 23:00:00 - 23:59:59	886	4.0%	0.25	2.7 MB	4.2%	0.76
Nov 30 00:00:00 - 00:59:59	669	3.0%	0.19	2.1 MB	3.2%	0.59
Nov 30 01:00:00 - 01:59:59	625	2.8%	0.17	2.3 MB	3.5%	0.65
Nov 30 02:00:00 - 02:59:59	516	2.3%	0.14	1.8 MB	2.8%	0.51
Nov 30 03:00:00 - 03:59:59	453	2.0%	0.13	1.7 MB	2.6%	0.48
Nov 30 04:00:00 - 04:15:00	136	0.6%	0.15	383.4 KB	0.6%	0.43
TOTAL: 24:00:00	22179	100.0%	0.26	64.1 MB	100.0%	0.76

Sites sending bad articles:

Server		Total	Group	Duplic	Other
1	xanadu-bbs.net	14156	502	0	13654
2	news-out.mixmin.net	4605	10	0	4595
3	newsfeed.neva.ru	4531	1551	7	2973
4	feeder.eternal-september.org	2023	253	0	1770
5	au2pb.net	870	779	0	91
6	newsfeed.fu-berlin.de	618	65	0	553
7	newsfeeds.xmission.com	173	108	0	65
8	nntp.pasdenom.info	69	59	0	10
9	news.swapon.de	41	0	0	41
TOTAL: 9		27086	3327	7	23752

Unwanted newsgroups [Top 20]:

Newsgroup	Count
pld.cvs.commit	844
fa.linux.kernel	295
mailing.freebsd.pkg-fallout	220
ut.test	174
lada.talk	128
alt.politics	122
it-alt.sport.calcio.juventus	101
mailing.freebsd.svn-ports-all	76
mailing.freebsd.svn-ports-head	72
lada.auto	61
alt.windows7.general	59
alt.survival	55
mailing.freebsd.ports-bugs	49
mailing.openbsd.source-changes	39
alt.politics.scorched-earth	37
mailing.freebsd.svn-src-all	33
fa.freebsd.cvs-all	32
mailing.freebsd.svn-src-head	30
mpc.lists.freebsd.ports.bugs	27
fa.openbsd.source-changes	27
TOTAL: 220	3327

INND Perl filter [Top 20]:

Reason	Count
EMP (md5)	10623
EMP (phn path)	2862
EMP (phl)	969
PFM bot misc	136
EMP (phn nph)	89
Too many newsgroups	52
HTML Multipart	42
Binary Payload	17
Binary Image: misplaced jpg	8
Too many newsgroups (low_xpost)	7
HTML post	3
User-issued spam cancel	1
Binary: misplaced par2	1
Binary: misplaced pdf	1
Binary: misplaced cbr	1
TOTAL: 15	14812

Miscellaneous innd statistics [Top 10]:

Event	Server	Number
Huge articles
	xanadu-bbs.net	8287
	feeder.eternal-september.org	73
	newsfeeds.xmission.com	53
	au2pb.net	43
	news-out.mixmin.net	17
	nntp.pasdenom.info	8
	TOTAL: 6	8481
Including strange strings
	newsfeed.fu-berlin.de	364
	feeder.eternal-september.org	29
	news.swapon.de	23
	news-out.mixmin.net	19
	newsfeeds.xmission.com	9
	au2pb.net	8
	newsfeed.neva.ru	5
	xanadu-bbs.net	2
	TOTAL: 8	459
TOTAL: 2		8940

Outgoing Feeds (innfeed) by Articles:

Server		Offered	Taken	Refused	Reject	Spool	%Took	Elapsed
1	au2pb	18503	152	17371	110	0	0%	23:59:47
2	usenet.pasdenom.info	25361	120	21308	593	12	0%	23:59:27
3	xanadu-bbs	22501	72	19436	106	18	0%	23:59:46
4	fu-berlin.de	20560	23	20528	9	0	0%	23:59:45
5	news.mixmin.net	18582	10	17879	1	2	0%	23:59:45
6	xmission	23662	6	19699	0	2	0%	23:59:47
7	neva.ru	21429	3	20577	23	2	0%	23:59:21
8	eternal-september	17093	3	16152	0	4	0%	23:59:46
9	news.swapon.de	1755	2	1721	3	0	0%	23:59:12
TOTAL: 9		169446	391	154671	845	40	0%	215:56:36

Outgoing Feeds (innfeed) by Volume:

Server		AcceptVol	RejectVol	TotalVol	Vol/Art	Elapsed
1	au2pb	577.9 KB	268.2 KB	846.2 KB	3.2 KB	23:59:47
2	usenet.pasdenom.info	494.2 KB	1.3 MB	1.7 MB	2.5 KB	23:59:27
3	xanadu-bbs	445.1 KB	226.2 KB	671.3 KB	3.8 KB	23:59:46
4	fu-berlin.de	97.9 KB	11.2 KB	109.0 KB	3.4 KB	23:59:45
5	news.mixmin.net	46.8 KB	13.6 KB	60.4 KB	5.5 KB	23:59:45
6	neva.ru	29.4 KB	95.2 KB	124.5 KB	4.8 KB	23:59:21
7	xmission	15.2 KB	0.0 KB	15.2 KB	2.5 KB	23:59:47
8	eternal-september	7.0 KB	0.0 KB	7.0 KB	2.3 KB	23:59:46
9	news.swapon.de	1.5 KB	5.4 KB	7.0 KB	1.4 KB	23:59:12
TOTAL: 9		1.7 MB	1.9 MB	3.5 MB	2.9 KB	215:56:36

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed
1	202.89.176.220	287	76	187.1 KB	71	0	0	04:29:41
TOTAL: 1		287	76	187.1 KB	71	0	0	64:03:20

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Elapsed
1	unresolved	424	76	187.1 KB	71	54:43:13
2	*.tampfl.dsl-w.verizon.net	10	0	0.0 KB	0	03:36:20
3	*.chello.nl	6	0	0.0 KB	0	01:42:54
4	*.149.22.98.dynamic.ip.windstream.net	1	0	0.0 KB	0	00:30:17
5	*.bbox.io	10	0	0.0 KB	0	03:30:33
TOTAL: 5		451	76	187.1 KB	71	64:03:20

NNRP auth users [Top 20]:

User	Conn
moussa	287
TOTAL: 1	287

NNRP total resource statistics [Top 20]:

System	User(ms)	System(ms)	Idle(ms)	Elapsed
63.142.120.8	8.352	2.505	0.000	42:29:50
162.212.88.214	0.400	0.164	0.000	07:34:09
202.89.176.220	29.361	6.350	0.731	04:29:41
pool-71-98-160-84.tampfl.dsl-w.verizon.net	0.689	0.158	0.000	03:36:20
tempe0.bbox.io	0.854	0.184	0.000	03:30:33
dhcp-089-099-203-254.chello.nl	0.513	0.093	0.000	01:42:54
h188.149.22.98.dynamic.ip.windstream.net	0.076	0.008	0.000	00:30:17
89.99.203.254	0.097	0.016	0.000	00:09:30
69.160.37.54	1.863	0.439	0.000	00:00:02
TOTAL: 9	42.205	9.917	0.731	64:03:20

Curious NNRP server explorers [Top 20]:

System	Conn
63.142.120.8	107
69.160.37.54	25
pool-71-98-160-84.tampfl.dsl-w.verizon.net	10
tempe0.bbox.io	10
dhcp-089-099-203-254.chello.nl	6
162.212.88.214	4
h188.149.22.98.dynamic.ip.windstream.net	1
89.99.203.254	1
TOTAL: 8	164

NNRP client timeouts [Top 20]:

System	Conn	Peer
pool-71-98-160-84.tampfl.dsl-w.verizon.net	7	0
tempe0.bbox.io	7	0
dhcp-089-099-203-254.chello.nl	3	0
202.89.176.220	2	0
h188.149.22.98.dynamic.ip.windstream.net	1	0
TOTAL: 5	20	0

Newsgroup request counts (by category):

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

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

Newsgroup		Count
1	comp.os.vms	21
2	comp.arch.embedded	15
3	comp.arch	9
4	comp.sys.ibm.pc.games.action	8
5	comp.os.os2.misc	7
6	comp.sys.ibm.pc.games.war-historical	7
7	comp.ai.philosophy	4
8	comp.os.linux.networking	3
9	comp.ai.neural-nets	2
TOTAL: 9		76

Daily Usenet report for csiph.com

Nov 29 04:15:00 -- Nov 30 04:15:00