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

Log entries by program:

Program name	Lines	%Lines	Size	%Size
inn	48777	48.6%	7.3 MB	60.7%
nnrpd	33205	33.1%	2.8 MB	23.1%
innd	16413	16.4%	1.7 MB	13.9%
innfeed	1871	1.9%	290.5 KB	2.4%
controlchan	1	0.0%	0.1 KB	0.0%
TOTAL: 5	100267	100.0%	12.0 MB	100.0%

History cache:

Reason	Count	%Count
Positive hits	266808	48.4%
Negative hits	233419	42.3%
Do not exist	46199	8.4%
Cache misses	5272	1.0%
TOTAL: 4	551698	100.0%

INND timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article cancel	00:00:02.948	0.0%	571	0.000	5.163	55.000
article cleanup	00:00:00.295	0.0%	45835	0.000	0.006	0.029
article logging	00:00:00.582	0.0%	46418	0.000	0.013	0.156
article parse	00:00:02.427	0.0%	240725	0.002	0.010	0.178
article write	00:01:22.960	0.1%	28179	0.160	2.944	10.640
artlog/artcncl	00:00:00.006	0.0%	538	0.000	0.011	0.062
artlog/artparse	00:00:00.006	0.0%	627	0.000	0.010	0.167
data move	00:00:00.273	0.0%	714330	0.000	0.000	0.002
hisgrep/artcncl	00:00:00.101	0.0%	570	0.000	0.177	12.000
hishave/artcncl	00:00:00.001	0.0%	571	0.000	0.002	1.000
hishave/artparse	00:00:00.004	0.0%	627	0.000	0.006	1.000
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	00:00:02.201	0.0%	553570	0.001	0.004	0.029
history sync	00:00:01.818	0.0%	356	0.000	5.107	80.500
history write	00:00:30.408	0.0%	45835	0.068	0.663	5.471
hiswrite/artcncl	00:00:00.000	0.0%	1	0.000	0.000	0.000
hiswrite/artparse	00:00:00.455	0.0%	625	0.000	0.728	24.000
idle	23:56:06.821	99.7%	699325	26.000	123.214	428.650
nntp read	00:00:02.197	0.0%	698615	0.000	0.003	0.007
overview write	00:00:45.074	0.1%	28179	0.182	1.600	10.731
perl filter	00:01:14.335	0.1%	45835	0.995	1.622	3.012
python filter	00:00:00.000	0.0%	0	0.000	0.000	0.000
site send	00:00:00.503	0.0%	56358	0.000	0.009	0.026
TOTAL: 24:00:53.639	24:00:13.415	100.0%	-	-	-	-

INNfeed timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article new	00:00:00.069	0.0%	28148	0.000	0.002	0.020
article prepare	00:00:00.001	0.0%	7020	0.000	0.000	0.042
article read	00:00:00.222	0.0%	1314	0.000	0.169	23.000
backlog stats	00:00:00.108	0.0%	307236	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.320	0.0%	238166	0.000	0.006	0.019
data write	00:00:01.842	0.0%	215577	0.003	0.009	0.017
idle	23:54:25.179	100.0%	307236	115.876	280.127	1071.835
status file	00:00:00.074	0.0%	185	0.000	0.400	1.000
TOTAL: 23:54:32.696	23:54:28.815	100.0%	-	-	-	-

nnrpd timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
hisgrep	00:00:01.206	0.0%	40622	0.000	0.030	0.252
idle	119:40:45.946	100.0%	72334	0.000	5956.341	600180.333
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:00:00.963	0.0%	145967	0.000	0.007	0.789
readart	00:00:08.092	0.0%	3649	0.000	2.218	45.000
TOTAL: 119:43:06.134	119:40:56.207	100.0%	-	-	-	-

Control commands to INND:

Command	Number
L	1
flush	4
flushlogs	2
go	2
logmode	2
mode	147
pause	2
paused	2
reload	2
reserve	2
TOTAL: 10	166

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed
1	feeder.eternal-september.org	10	42483	7652	32411	2420	18%	25:09:19
2	au2pb.net	1	30345	5776	23640	929	19%	23:50:32
3	xanadu-bbs.net	1	46795	4253	34816	7726	9%	24:03:48
4	news-out.mixmin.net	4	33668	4074	27022	2572	12%	24:18:42
5	newsfeed.neva.ru	144	59473	2911	52426	4136	4%	72:15:13
6	newsfeeds.xmission.com	1	28436	1690	26667	79	5%	23:19:45
7	newsfeed.fu-berlin.de	69	33195	1410	31423	362	4%	36:54:15
8	nntp.pasdenom.info	4	35562	498	34964	100	1%	27:39:36
9	news.swapon.de	3	2204	224	1973	7	10%	23:46:34
10	localhost	50	14303	0	14303	0	0%	00:01:01
TOTAL: 10		287	326464	28488	279645	18331	8%	281:18:45

Incoming Volume (INN):

Server		AcceptVol	RejVol	TotalVol	%Acc	Vol/Art
1	feeder.eternal-september.org	21.0 MB	9.3 MB	30.2 MB	69%	3.1 KB
2	au2pb.net	15.2 MB	9.9 MB	25.1 MB	60%	3.8 KB
3	xanadu-bbs.net	11.8 MB	150.5 MB	162.4 MB	7%	13.9 KB
4	news-out.mixmin.net	11.8 MB	5.3 MB	17.2 MB	68%	2.6 KB
5	newsfeed.neva.ru	9.6 MB	17.2 MB	26.7 MB	35%	3.9 KB
6	newsfeeds.xmission.com	4.9 MB	626.2 KB	5.5 MB	88%	3.2 KB
7	newsfeed.fu-berlin.de	3.2 MB	959.3 KB	4.1 MB	77%	2.4 KB
8	nntp.pasdenom.info	1.1 MB	968.2 KB	2.1 MB	54%	3.5 KB
9	news.swapon.de	543.4 KB	20.4 KB	563.8 KB	96%	2.4 KB
10	localhost	0.0 KB	0.0 KB	0.0 KB	0%	0
TOTAL: 10		79.1 MB	194.7 MB	273.9 MB	28%	6.0 KB

Incoming articles:

Date	Articles	%Arts	Art/sec	Size	%Size	KB/sec
Oct 16 04:15:00 - 04:59:59	418	1.5%	0.15	1.4 MB	1.7%	0.52
Oct 16 05:00:00 - 05:59:59	568	2.0%	0.16	1.7 MB	2.2%	0.50
Oct 16 06:00:00 - 06:59:59	838	2.9%	0.23	2.3 MB	2.9%	0.65
Oct 16 07:00:00 - 07:59:59	1254	4.4%	0.35	3.6 MB	4.6%	1.03
Oct 16 08:00:00 - 08:59:59	1420	4.9%	0.39	3.9 MB	4.9%	1.10
Oct 16 09:00:00 - 09:59:59	1494	5.2%	0.41	3.9 MB	4.9%	1.10
Oct 16 10:00:00 - 10:59:59	1544	5.4%	0.43	3.9 MB	4.9%	1.11
Oct 16 11:00:00 - 11:59:59	1287	4.5%	0.36	3.3 MB	4.2%	0.94
Oct 16 12:00:00 - 12:59:59	1286	4.5%	0.36	3.0 MB	3.8%	0.87
Oct 16 13:00:00 - 13:59:59	1451	5.0%	0.40	4.0 MB	5.1%	1.14
Oct 16 14:00:00 - 14:59:59	1578	5.5%	0.44	4.3 MB	5.4%	1.21
Oct 16 15:00:00 - 15:59:59	1608	5.6%	0.45	4.4 MB	5.5%	1.25
Oct 16 16:00:00 - 16:59:59	2035	7.1%	0.57	4.8 MB	6.1%	1.38
Oct 16 17:00:00 - 17:59:59	1633	5.7%	0.45	4.9 MB	6.2%	1.40
Oct 16 18:00:00 - 18:59:59	1469	5.1%	0.41	4.0 MB	5.0%	1.14
Oct 16 19:00:00 - 19:59:59	1496	5.2%	0.42	4.5 MB	5.7%	1.28
Oct 16 20:00:00 - 20:59:59	1303	4.5%	0.36	3.3 MB	4.1%	0.93
Oct 16 21:00:00 - 21:59:59	1299	4.5%	0.36	3.8 MB	4.8%	1.08
Oct 16 22:00:00 - 22:59:59	1018	3.5%	0.28	3.2 MB	4.1%	0.92
Oct 16 23:00:00 - 23:59:59	847	2.9%	0.24	2.7 MB	3.4%	0.77
Oct 17 00:00:00 - 00:59:59	658	2.3%	0.18	2.0 MB	2.5%	0.57
Oct 17 01:00:00 - 01:59:59	554	1.9%	0.15	1.8 MB	2.3%	0.52
Oct 17 02:00:00 - 02:59:59	449	1.6%	0.12	1.8 MB	2.3%	0.51
Oct 17 03:00:00 - 03:59:59	493	1.7%	0.14	1.7 MB	2.1%	0.47
Oct 17 04:00:00 - 04:15:00	756	2.6%	0.84	1.2 MB	1.5%	1.32
TOTAL: 24:00:00	28756	100.0%	0.33	79.4 MB	100.0%	0.94

Sites sending bad articles:

Server		Total	Group	Duplic	Other
1	xanadu-bbs.net	7722	790	0	6932
2	newsfeed.neva.ru	4137	1576	0	2561
3	news-out.mixmin.net	2596	24	0	2572
4	feeder.eternal-september.org	2459	263	2	2194
5	au2pb.net	949	859	0	90
6	newsfeed.fu-berlin.de	792	28	0	764
7	nntp.pasdenom.info	94	64	2	28
8	newsfeeds.xmission.com	88	74	0	14
9	news.swapon.de	46	0	0	46
TOTAL: 9		18883	3678	4	15201

Unwanted newsgroups [Top 20]:

Newsgroup	Count
fa.linux.kernel	821
mailing.freebsd.pkg-fallout	261
lada.talk	185
ut.test	116
mailing.freebsd.svn-ports-all	115
mailing.freebsd.svn-ports-head	112
mailing.freebsd.ports-bugs	97
alt.politics.scorched-earth	79
lada.auto	76
mailing.openbsd.source-changes	75
mailing.gcc.gcc-cvs	72
alt.politics	70
pld.cvs.commit	61
fa.openbsd.source-changes	54
gmane.linux.alsa.devel	49
mailing.freebsd.svn-src-all	47
lada.test	45
alt.windows7.general	42
mailing.freebsd.svn-src-head	41
alt.survival	41
TOTAL: 271	3678

INND Perl filter [Top 20]:

Reason	Count
EMP (md5)	10128
EMP (phn path)	2383
EMP (phl)	896
EMP (phn nph)	265
PFM bot misc	113
Too many newsgroups (low_xpost)	52
HTML Multipart	51
Too many newsgroups	45
Binary Image: misplaced jpg	33
HTML post	9
HTML Image Tags	6
Too many newsgroups (meow)	2
Binary Image: misplaced jpeg	1
Binary Payload	1
Binary: non-binary distribution	1
Binary: misplaced par2	1
TOTAL: 16	13987

Miscellaneous innd statistics [Top 10]:

Event	Server	Number
Huge articles
	xanadu-bbs.net	503
	au2pb.net	58
	feeder.eternal-september.org	43
	news-out.mixmin.net	20
	nntp.pasdenom.info	8
	newsfeeds.xmission.com	5
	TOTAL: 6	637
Including strange strings
	newsfeed.fu-berlin.de	439
	news.swapon.de	39
	feeder.eternal-september.org	39
	news-out.mixmin.net	25
	au2pb.net	16
	xanadu-bbs.net	12
	newsfeed.neva.ru	6
	newsfeeds.xmission.com	5
	nntp.pasdenom.info	2
	TOTAL: 9	583
TOTAL: 2		1220

Outgoing Feeds (innfeed) by Articles:

Server		Offered	Taken	Refused	Reject	Spool	%Took	Elapsed
1	au2pb	23879	299	22483	181	1	1%	23:59:58
2	usenet.pasdenom.info	33756	207	27358	721	11	0%	23:59:57
3	xanadu-bbs	26408	110	24344	40	7	0%	23:59:58
4	fu-berlin.de	27047	51	26966	26	4	0%	23:59:48
5	news.mixmin.net	25192	23	24449	16	11	0%	23:59:55
6	xmission	33870	14	26786	0	8	0%	23:59:56
7	neva.ru	26914	12	25513	46	52	0%	23:59:57
8	eternal-september	21329	5	20225	2	0	0%	23:59:57
9	news.swapon.de	2053	1	2036	4	0	0%	23:55:07
TOTAL: 9		220448	722	200160	1036	94	0%	215:54:33

Outgoing Feeds (innfeed) by Volume:

Server		AcceptVol	RejectVol	TotalVol	Vol/Art	Elapsed
1	au2pb	1.3 MB	435.1 KB	1.7 MB	3.6 KB	23:59:58
2	usenet.pasdenom.info	926.7 KB	1.6 MB	2.5 MB	2.8 KB	23:59:57
3	xanadu-bbs	625.9 KB	84.4 KB	710.3 KB	4.7 KB	23:59:58
4	fu-berlin.de	295.8 KB	37.3 KB	333.2 KB	4.3 KB	23:59:48
5	news.mixmin.net	131.2 KB	30.1 KB	161.3 KB	4.1 KB	23:59:55
6	neva.ru	67.3 KB	265.6 KB	332.9 KB	5.7 KB	23:59:57
7	xmission	33.6 KB	0.0 KB	33.6 KB	2.4 KB	23:59:56
8	eternal-september	21.8 KB	2.9 KB	24.7 KB	3.5 KB	23:59:57
9	news.swapon.de	4.4 KB	10.0 KB	14.4 KB	2.9 KB	23:55:07
TOTAL: 9		3.3 MB	2.4 MB	5.8 MB	3.4 KB	215:54:33

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Elapsed
1	202.89.176.220	288	83	238.2 KB	75	04:16:01
2	challenger.nielsenmedia.com	4	6	14.8 KB	2	01:00:28
3	c-73-195-247-24.hsd1.nj.comcast.net	14	6	14.8 KB	2	02:26:25
4	tempe0.bbox.io	3	2	2.6 KB	2	00:30:41
5	dhcp-089-099-203-254.chello.nl	30	1	1.7 KB	1	12:48:56
TOTAL: 5		339	98	272.0 KB	82	119:43:00

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Elapsed
1	unresolved	560	83	238.2 KB	75	100:31:30
2	*.nielsenmedia.com	4	6	14.8 KB	2	01:00:28
3	*.hsd1.nj.comcast.net	14	6	14.8 KB	2	02:26:25
4	*.bbox.io	3	2	2.6 KB	2	00:30:41
5	*.chello.nl	30	1	1.7 KB	1	12:48:56
6	*.tu.ok.cox.net	3	0	0.0 KB	0	02:24:56
TOTAL: 6		614	98	272.0 KB	82	119:43:00

NNRP auth users [Top 20]:

User	Conn
moussa	288
TOTAL: 1	288

NNRP total resource statistics [Top 20]:

System	User(ms)	System(ms)	Idle(ms)	Elapsed
162.212.88.214	1.225	0.836	0.000	55:16:42
108.175.241.207	19.658	4.449	0.000	40:19:58
dhcp-089-099-203-254.chello.nl	2.399	0.459	0.000	12:48:56
202.89.176.220	27.261	5.925	0.704	04:16:01
c-73-195-247-24.hsd1.nj.comcast.net	1.274	0.158	0.000	02:26:25
ip72-222-107-224.tu.ok.cox.net	0.263	0.104	0.000	02:24:56
challenger.nielsenmedia.com	0.475	0.045	0.000	01:00:28
71.94.21.184	0.239	0.408	0.000	00:38:33
tempe0.bbox.io	0.297	0.063	0.000	00:30:41
173.0.15.162	0.202	0.325	0.000	00:00:11
69.160.37.54	1.945	0.381	0.000	00:00:03
208.100.26.229	0.163	0.016	0.000	00:00:01
TOTAL: 12	55.401	13.169	0.704	119:43:00

Curious NNRP server explorers [Top 20]:

System	Conn
108.175.241.207	231
69.160.37.54	25
162.212.88.214	12
ip72-222-107-224.tu.ok.cox.net	3
208.100.26.229	2
173.0.15.162	1
71.94.21.184	1
TOTAL: 7	275

NNRP unrecognized commands (by host):

System	Conn
71.94.21.184	1
TOTAL: 1	1

NNRP unrecognized commands (by command):

Command	Count
XFEATURE COMPRESS GZIP	1
TOTAL: 1	1

NNRP client timeouts [Top 20]:

System	Conn	Peer
dhcp-089-099-203-254.chello.nl	22	0
c-73-195-247-24.hsd1.nj.comcast.net	4	0
ip72-222-107-224.tu.ok.cox.net	3	0
challenger.nielsenmedia.com	2	0
tempe0.bbox.io	1	0
TOTAL: 5	32	0

Newsgroup request counts (by category):

Category		Count	Pct
1	comp	97	99.0%
2	news	1	1.0%
TOTAL: 2		98	100.0%

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

Newsgroup		Count
1	comp.arch.embedded	23
2	comp.sys.ibm.pc.games.war-historical	20
3	comp.arch	16
4	comp.lang.awk	12
5	comp.sys.ibm.pc.hardware.storage	8
6	comp.os.linux.networking	5
7	comp.os.vms	5
8	comp.sys.ibm.as400.misc	2
9	comp.sys.ibm.ps2.hardware	2
10	comp.ai.neural-nets	1
11	comp.apps.spreadsheets	1
12	news.software.nntp	1
13	comp.sys.ibm.pc.games.rpg	1
14	comp.ai.philosophy	1
TOTAL: 14		98

Daily Usenet report for csiph.com

Oct 16 04:15:00 -- Oct 17 04:15:00