Daily Usenet report for csiph.com: Apr 3 04:15:00

Log entries by program:

Program name	Lines	%Lines	Size	%Size
inn	23429	51.3%	6.1 MB	66.7%
innd	17447	38.2%	2.3 MB	25.3%
innfeed	3587	7.8%	622.4 KB	6.6%
nnrpd	1213	2.7%	131.1 KB	1.4%
nocem	32	0.1%	3.6 KB	0.0%
controlchan	1	0.0%	0.1 KB	0.0%
TOTAL: 6	45709	100.0%	9.2 MB	100.0%

History cache:

Reason	Count	%Count
Positive hits	395782	57.0%
Negative hits	274993	39.6%
Do not exist	22714	3.3%
Cache misses	363	0.1%
TOTAL: 4	693852	100.0%

INND timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article cancel	00:00:00.382	0.0%	35	0.000	10.914	18.000
article cleanup	00:00:00.118	0.0%	22371	0.000	0.005	0.038
article logging	00:00:00.316	0.0%	22916	0.000	0.014	0.126
article parse	00:00:00.921	0.0%	67935	0.000	0.014	0.137
article write	00:00:08.810	0.0%	19134	0.149	0.460	6.492
artlog/artcncl	00:00:00.001	0.0%	35	0.000	0.029	1.000
artlog/artparse	00:00:00.027	0.0%	472	0.000	0.057	16.000
data move	00:00:00.209	0.0%	642738	0.000	0.000	0.002
hisgrep/artcncl	00:00:00.013	0.0%	35	0.000	0.371	2.000
hishave/artcncl	00:00:00.022	0.0%	35	0.000	0.629	2.100
hishave/artparse	00:00:00.002	0.0%	466	0.000	0.004	0.143
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	00:00:08.168	0.0%	697531	0.001	0.012	0.097
history sync	00:00:01.289	0.0%	380	0.000	3.392	74.667
history write	00:00:17.407	0.0%	22372	0.050	0.778	5.673
hiswrite/artcncl	00:00:00.000	0.0%	0	0.000	0.000	0.000
hiswrite/artparse	00:00:00.316	0.0%	466	0.000	0.678	6.000
idle	23:57:29.645	99.8%	648408	76.978	133.018	459.278
nntp read	00:00:02.412	0.0%	650265	0.002	0.004	0.006
overview write	00:01:46.079	0.1%	19134	0.074	5.544	1235.344
perl filter	00:00:30.436	0.0%	22366	1.089	1.361	2.212
python filter	00:00:00.000	0.0%	0	0.000	0.000	0.000
site send	00:00:00.287	0.0%	38301	0.000	0.007	0.029
TOTAL: 24:01:05.007	24:00:26.860	100.0%	-	-	-	-

INNfeed timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article new	00:00:00.035	0.0%	19439	0.000	0.002	0.028
article prepare	00:00:00.003	0.0%	20136	0.000	0.000	0.014
article read	00:00:00.330	0.0%	2059	0.000	0.160	44.000
backlog stats	00:00:00.254	0.0%	451491	0.000	0.001	0.003
callbacks	00:00:00.000	0.0%	0	0.000	0.000	0.000
data read	00:00:01.599	0.0%	354253	0.001	0.005	0.011
data write	00:00:01.969	0.0%	340340	0.002	0.006	0.010
idle	23:53:31.321	100.0%	451491	111.800	190.505	663.328
status file	00:00:00.223	0.0%	306	0.000	0.729	3.250
TOTAL: 23:53:44.591	23:53:35.734	100.0%	-	-	-	-

nnrpd timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
idle	53:56:36.608	99.8%	900	58.500	215774.009	600138.000
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:00:00.022	0.0%	2128	0.000	0.010	0.167
readart	00:00:00.569	0.0%	82	0.000	6.939	43.000
TOTAL: 54:01:37.889	53:56:37.199	99.8%	-	-	-	-

Control commands to INND:

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

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed
1	newsfeeds.xmission.com	2	18142	4324	13750	68	23%	23:24:39
2	news-out.aioe.org	4	19121	4200	14757	164	21%	24:08:50
3	feeder.eternal-september.org	2	21005	2833	17757	415	13%	22:56:40
4	csiph-out.feeder.erje.net	1440	96540	1322	94670	548	1%	118:47:45
5	csiph-out.news.weretis.net	4	36585	1264	35176	145	3%	43:45:12
6	newsfeed.neva.ru	145	18847	988	17613	246	5%	71:40:07
7	news-out.mixmin.net	3	20389	962	18877	550	4%	24:08:43
8	newsfeed.fu-berlin.de	17	21661	906	20374	381	4%	31:47:55
9	csiph-out.news.xs4all.nl	861	20821	798	19424	599	3%	71:28:36
10	csiph-out.feed.uzoreto.com	864	30035	363	29246	426	1%	71:07:05
11	news.freedyn.net	3	21927	352	21438	137	1%	24:08:58
12	news.fcku.it	9	2421	331	2089	1	13%	22:50:25
13	news-out.neodome.net	1	20186	141	20016	29	0%	23:59:55
14	nntp.pasdenom.info	4	13728	51	13669	8	0%	23:57:45
15	news.swapon.de	11	1711	43	1668	0	2%	24:14:47
16	news.bbs.nz	2	18075	39	18036	0	0%	23:59:29
17	csiph-out.news.tnetconsulting.net	2	4028	16	4003	9	0%	07:47:49
18	localhost	42	16	16	0	0	100%	00:00:04
19	news.samoylyk.net	3	18732	7	18724	1	0%	25:43:12
20	xanadu-bbs.net	29	504	0	504	0	0%	29:38:21
TOTAL: 20		3448	404474	18956	381791	3727	4%	709:36:17

Incoming Volume (INN):

Server		AcceptVol	DupVol	RejVol	TotalVol	%Acc	Vol/Art
1	newsfeeds.xmission.com	12.6 MB	0.0 KB	4.6 MB	17.2 MB	73%	4.0 KB
2	news-out.aioe.org	9.6 MB	0.0 KB	596.8 KB	10.2 MB	94%	2.4 KB
3	csiph-out.feeder.erje.net	8.7 MB	0.0 KB	9.9 MB	18.5 MB	46%	10.1 KB
4	feeder.eternal-september.org	7.0 MB	2.3 KB	2.3 MB	9.3 MB	75%	2.9 KB
5	csiph-out.news.weretis.net	3.7 MB	2.3 KB	3.2 MB	7.0 MB	53%	5.1 KB
6	news-out.mixmin.net	2.9 MB	0.0 KB	1.3 MB	4.2 MB	68%	2.9 KB
7	csiph-out.news.xs4all.nl	2.4 MB	0.0 KB	6.5 MB	8.9 MB	26%	6.5 KB
8	newsfeed.fu-berlin.de	2.3 MB	0.0 KB	1.0 MB	3.3 MB	69%	2.6 KB
9	newsfeed.neva.ru	2.3 MB	0.0 KB	734.4 KB	3.0 MB	76%	2.5 KB
10	news.freedyn.net	1.2 MB	0.0 KB	721.0 KB	1.9 MB	62%	3.9 KB
11	csiph-out.feed.uzoreto.com	1.0 MB	0.0 KB	11.6 MB	12.6 MB	8%	16.3 KB
12	news.fcku.it	568.4 KB	0.0 KB	2.1 KB	570.5 KB	99%	1.7 KB
13	news-out.neodome.net	351.2 KB	2.3 KB	614.8 KB	968.3 KB	36%	5.7 KB
14	nntp.pasdenom.info	122.5 KB	0.0 KB	10.6 KB	133.1 KB	92%	2.3 KB
15	news.swapon.de	101.1 KB	0.0 KB	0.0 KB	101.1 KB	100%	2.4 KB
16	news.bbs.nz	67.3 KB	0.0 KB	0.0 KB	67.3 KB	100%	1.7 KB
17	csiph-out.news.tnetconsulting.net	43.8 KB	0.0 KB	108.5 KB	152.3 KB	28%	6.1 KB
18	localhost	24.1 KB	0.0 KB	0.0 KB	24.1 KB	100%	1.5 KB
19	news.samoylyk.net	14.5 KB	2.3 KB	2.3 KB	19.1 KB	75%	2.4 KB
20	xanadu-bbs.net	0.0 KB	0.0 KB	0.0 KB	0.0 KB	0%	0
TOTAL: 20		54.9 MB	9.3 KB	43.1 MB	98.0 MB	56%	4.4 KB

Incoming articles:

Date	Articles	%Arts	Art/sec	Size	%Size	KB/sec
Apr 3 04:15:00 - 04:59:59	249	1.3%	0.09	718.8 KB	1.3%	0.27
Apr 3 05:00:00 - 05:59:59	328	1.7%	0.09	1.2 MB	2.3%	0.35
Apr 3 06:00:00 - 06:59:59	562	2.9%	0.16	1.9 MB	3.5%	0.55
Apr 3 07:00:00 - 07:59:59	678	3.5%	0.19	1.7 MB	3.1%	0.49
Apr 3 08:00:00 - 08:59:59	889	4.6%	0.25	2.9 MB	5.2%	0.82
Apr 3 09:00:00 - 09:59:59	962	5.0%	0.27	2.5 MB	4.5%	0.72
Apr 3 10:00:00 - 10:59:59	972	5.1%	0.27	2.7 MB	4.9%	0.77
Apr 3 11:00:00 - 11:59:59	1003	5.2%	0.28	2.5 MB	4.5%	0.72
Apr 3 12:00:00 - 12:59:59	987	5.2%	0.27	2.6 MB	4.6%	0.73
Apr 3 13:00:00 - 13:59:59	1102	5.8%	0.31	2.7 MB	4.9%	0.78
Apr 3 14:00:00 - 14:59:59	1039	5.4%	0.29	3.1 MB	5.6%	0.89
Apr 3 15:00:00 - 15:59:59	1207	6.3%	0.34	3.2 MB	5.8%	0.92
Apr 3 16:00:00 - 16:59:59	1195	6.2%	0.33	3.5 MB	6.3%	0.99
Apr 3 17:00:00 - 17:59:59	1151	6.0%	0.32	2.7 MB	4.9%	0.77
Apr 3 18:00:00 - 18:59:59	962	5.0%	0.27	2.7 MB	4.9%	0.77
Apr 3 19:00:00 - 19:59:59	1034	5.4%	0.29	3.1 MB	5.5%	0.87
Apr 3 20:00:00 - 20:59:59	1002	5.2%	0.28	3.3 MB	5.9%	0.92
Apr 3 21:00:00 - 21:59:59	855	4.5%	0.24	2.3 MB	4.2%	0.66
Apr 3 22:00:00 - 22:59:59	637	3.3%	0.18	2.4 MB	4.4%	0.69
Apr 3 23:00:00 - 23:59:59	558	2.9%	0.15	1.6 MB	2.9%	0.46
Apr 4 00:00:00 - 00:59:59	556	2.9%	0.15	1.7 MB	3.1%	0.50
Apr 4 01:00:00 - 01:59:59	460	2.4%	0.13	1.3 MB	2.4%	0.37
Apr 4 02:00:00 - 02:59:59	369	1.9%	0.10	1.7 MB	3.0%	0.48
Apr 4 03:00:00 - 03:59:59	301	1.6%	0.08	1.0 MB	1.8%	0.29
Apr 4 04:00:00 - 04:15:00	80	0.4%	0.09	217.8 KB	0.4%	0.24
TOTAL: 24:00:00	19138	100.0%	0.22	55.4 MB	100.0%	0.66

Sites sending bad articles:

Server		Total	Group	Duplic	Other
1	newsfeed.fu-berlin.de	675	78	0	597
2	news-out.mixmin.net	610	159	0	451
3	csiph-out.news.xs4all.nl	605	28	0	577
4	csiph-out.feeder.erje.net	465	56	0	409
5	csiph-out.feed.uzoreto.com	437	9	0	428
6	feeder.eternal-september.org	428	70	1	357
7	news-out.aioe.org	275	117	0	158
8	newsfeed.neva.ru	247	70	0	177
9	csiph-out.news.weretis.net	196	72	1	123
10	news.freedyn.net	139	2	0	137
11	newsfeeds.xmission.com	80	8	0	72
12	csiph-out.news.tnetconsulting.net	52	30	1	21
13	news-out.neodome.net	33	0	1	32
14	nntp.pasdenom.info	8	0	0	8
15	news.swapon.de	5	0	0	5
16	news.samoylyk.net	1	0	1	0
17	news.fcku.it	1	1	0	0
TOTAL: 17		4257	700	5	3552

Unwanted newsgroups [Top 20]:

Newsgroup	Count
alt.computer.workshop	336
alt.bbs.synchronet	51
lada.talk	47
alt.survival	36
spline.eisfair	24
alt.politics	18
alt.politics.usa	16
mozilla.support.seamonkey	12
rocksolid.shared.test	10
0.akita-inu	9
it-alt.sport.calcio.juventus	9
mozilla.general	7
lada.auto	6
spline.fli4l.geschnatter	6
free.it.religioni.scientology	6
cakewalk.audio	5
mozilla.support.thunderbird	5
alt.binaries.pictures.purebeauty	5
mozilla.support.firefox	5
alt.christian.bible	4
TOTAL: 79	700

INND Perl filter [Top 20]:

Reason	Count
EMP (md5)	1767
EMP (phn path)	416
EMP (phl)	140
Too many newsgroups	82
0	61
HTML Multipart	36
EMP (phn nph)	9
Binary Payload	9
Scoring filter	7
Binary: misplaced binary	3
HTML post	3
Too many newsgroups (meow)	2
TOTAL: 12	2535

Miscellaneous innd statistics [Top 10]:

Event	Server	Number
Bad Message-ID's offered
	csiph-out.feeder.erje.net	55
	csiph-out.news.xs4all.nl	2
	csiph-out.feed.uzoreto.com	2
	TOTAL: 3	59
Huge articles
	csiph-out.feeder.erje.net	170
	csiph-out.feed.uzoreto.com	126
	newsfeeds.xmission.com	59
	csiph-out.news.xs4all.nl	54
	csiph-out.news.weretis.net	26
	feeder.eternal-september.org	12
	news-out.neodome.net	11
	news.freedyn.net	5
	news-out.mixmin.net	3
	TOTAL: 9	466
Including strange strings
	newsfeed.fu-berlin.de	359
	news-out.aioe.org	116
	csiph-out.news.weretis.net	19
	newsfeeds.xmission.com	12
	csiph-out.feed.uzoreto.com	10
	news-out.mixmin.net	10
	news.swapon.de	5
	csiph-out.feeder.erje.net	5
	csiph-out.news.xs4all.nl	4
	news.freedyn.net	3
	TOTAL: 12	545
No colon-space in header
	csiph-out.feeder.erje.net	3
	csiph-out.news.xs4all.nl	2
	csiph-out.feed.uzoreto.com	1
	TOTAL: 3	6
TOTAL: 4		1076

Outgoing Feeds (innfeed) by Articles:

Server		Offered	Taken	Refused	Reject	Spool	%Took	Elapsed
1	xanadu-bbs	22312	1160	17969	9	0	5%	23:59:54
2	news.freedyn.net	19202	634	18061	21	0	3%	23:59:54
3	news.samoylyk.net	19948	632	18493	5	77	3%	23:59:54
4	fu-berlin.de	18129	626	17503	0	0	3%	23:59:54
5	news.bbs.nz	36060	473	18023	6	0	1%	23:59:54
6	tnet	20003	184	18335	1	0	0%	23:59:54
7	erje	20830	182	17071	434	26	0%	23:59:54
8	newsfeed.xs4all.nl	19282	106	18103	33	224	0%	23:59:53
9	xmission	16510	43	14057	1	0	0%	23:59:54
10	news.uzoreto.com	18742	39	18305	98	0	0%	23:59:53
11	aioe	14344	37	13623	0	0	0%	23:59:54
12	neva.ru	17418	35	17129	118	0	0%	23:59:23
13	news.mixmin.net	18028	31	17218	0	0	0%	23:59:54
14	neodome.net	19627	31	18895	0	0	0%	23:59:54
15	news.swapon.de	1845	20	1772	0	0	1%	23:33:41
16	eternal-september	16200	18	15442	0	0	0%	23:59:48
17	weretis.net	17320	17	17110	0	0	0%	23:59:40
18	usenet.pasdenom.info	19141	7	18452	10	17	0%	23:59:54
19	news.fcku.it	2080	0	2052	0	0	0%	22:25:34
TOTAL: 19		337021	4275	297613	736	344	1%	453:56:40

Outgoing Feeds (innfeed) by Volume:

Server		AcceptVol	RejectVol	TotalVol	Volume/sec	Vol/Art	Elapsed
1	xanadu-bbs	8.0 MB	72.2 KB	8.1 MB	0.1 KB/s	7.1 KB	23:59:54
2	news.freedyn.net	6.7 MB	32.8 KB	6.7 MB	0.1 KB/s	10.5 KB	23:59:54
3	fu-berlin.de	6.6 MB	0.0 KB	6.6 MB	0.1 KB/s	10.8 KB	23:59:54
4	news.samoylyk.net	6.6 MB	29.2 KB	6.6 MB	0.1 KB/s	10.6 KB	23:59:54
5	news.bbs.nz	1.3 MB	10.1 KB	1.3 MB	0.0 KB/s	2.8 KB	23:59:54
6	tnet	466.9 KB	1.2 KB	468.1 KB	0.0 KB/s	2.5 KB	23:59:54
7	erje	422.0 KB	1.4 MB	1.8 MB	0.0 KB/s	3.1 KB	23:59:54
8	newsfeed.xs4all.nl	290.5 KB	102.4 KB	392.9 KB	0.0 KB/s	2.8 KB	23:59:53
9	xmission	125.0 KB	2.1 KB	127.1 KB	0.0 KB/s	2.9 KB	23:59:54
10	aioe	82.2 KB	0.0 KB	82.2 KB	0.0 KB/s	2.2 KB	23:59:54
11	neva.ru	68.6 KB	285.2 KB	353.8 KB	0.0 KB/s	2.3 KB	23:59:23
12	news.uzoreto.com	61.9 KB	236.1 KB	298.0 KB	0.0 KB/s	2.2 KB	23:59:53
13	news.mixmin.net	57.7 KB	0.0 KB	57.7 KB	0.0 KB/s	1.9 KB	23:59:54
14	neodome.net	51.3 KB	0.0 KB	51.3 KB	0.0 KB/s	1.7 KB	23:59:54
15	usenet.pasdenom.info	42.3 KB	18.1 KB	60.4 KB	0.0 KB/s	3.6 KB	23:59:54
16	news.swapon.de	42.2 KB	0.0 KB	42.2 KB	0.0 KB/s	2.1 KB	23:33:41
17	eternal-september	31.5 KB	0.0 KB	31.5 KB	0.0 KB/s	1.8 KB	23:59:48
18	weretis.net	29.1 KB	0.0 KB	29.1 KB	0.0 KB/s	1.7 KB	23:59:40
19	news.fcku.it	0.0 KB	0.0 KB	0.0 KB	0.0 KB/s	0	22:25:34
TOTAL: 19		30.8 MB	2.2 MB	33.0 MB	0.0 KB/s	6.8 KB	453:56:40

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed
1	a131033.upc-a.chello.nl	61	38	70.3 KB	5	0	0	18:18:52
2	96-42-18-55.dhcp.mdsn.wi.charter.com	38	32	55.5 KB	19	16	14	08:11:49
3	5-168-143-94.cust.centrio.cz	3	12	30.8 KB	2	0	0	01:30:18
TOTAL: 3		102	82	156.6 KB	26	16	14	54:01:36

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed
1	*.upc-a.chello.nl	61	38	70.3 KB	5	0	0	18:18:52
2	*.dhcp.mdsn.wi.charter.com	38	32	55.5 KB	19	16	14	08:11:49
3	*.cust.centrio.cz	3	12	30.8 KB	2	0	0	01:30:18
4	*.census.shodan.io	1	0	0.0 KB	0	0	0	00:00:01
5	unresolved	74	0	0.0 KB	0	0	0	24:00:17
6	*.ph.ph.cox.net	4	0	0.0 KB	0	0	0	02:00:15
7	*.security.ipip.net	1	0	0.0 KB	0	0	0	00:00:01
TOTAL: 7		182	82	156.6 KB	26	16	14	54:01:36

NNRP auth users [Top 20]:

User	Conn
ohlandl	14
ctomczyk	3
TOTAL: 2	17

NNRP total resource statistics [Top 20]:

System	User(ms)	System(ms)	Idle(ms)	Elapsed
91.187.33.87	5.218	1.142	0.000	24:00:15
a131033.upc-a.chello.nl	4.696	0.919	0.000	18:18:52
96-42-18-55.dhcp.mdsn.wi.charter.com	3.241	0.722	0.034	08:11:49
ip72-222-200-117.ph.ph.cox.net	0.411	0.102	0.000	02:00:15
5-168-143-94.cust.centrio.cz	0.250	0.070	0.007	01:30:18
scan-141.security.ipip.net	0.064	0.016	0.000	00:00:01
94.161.170.142	0.047	0.032	0.000	00:00:01
cloud.census.shodan.io	0.055	0.024	0.000	00:00:01
94.162.11.201	0.069	0.009	0.000	00:00:01
TOTAL: 9	14.051	3.036	0.041	54:01:36

Curious NNRP server explorers [Top 20]:

System	Conn
91.187.33.87	72
ip72-222-200-117.ph.ph.cox.net	4
94.162.11.201	1
scan-141.security.ipip.net	1
94.161.170.142	1
cloud.census.shodan.io	1
TOTAL: 6	80

NNRP unrecognized commands (by host):

System	Conn
scan-141.security.ipip.net	4
TOTAL: 1	4

NNRP unrecognized commands (by command):

Command	Count
Host: 69.160.37.58:119	1
Connection: close	1
GET / HTTP/1.1	1
User-Agent: HTTP Banner Detection (https...	1
TOTAL: 4	4

NNRP client timeouts [Top 20]:

System	Conn	Peer
96-42-18-55.dhcp.mdsn.wi.charter.com	8	0
ip72-222-200-117.ph.ph.cox.net	4	0
5-168-143-94.cust.centrio.cz	3	0
TOTAL: 3	15	0

Newsgroup request counts (by category):

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

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

Newsgroup		Count
1	comp.sys.ibm.ps2.hardware	70
2	comp.lang.javascript	12
TOTAL: 2		82

Daily Usenet report for csiph.com

Apr 3 04:15:00 -- Apr 4 04:15:00