Daily Usenet report

Jul 22 03:00:07 -- Jul 23 03:00:05

Log entries by program
History cache
INND timer
nnrpd timer
Control commands to INND
Incoming Feeds (INN)
Incoming Volume (INN)
Incoming articles
CNFS buffer status
Sites sending bad articles
Unwanted newsgroups
Miscellaneous innd statistics
NNRP readership statistics
NNRP readership statistics (by domain)
NNRP total resource statistics
Curious NNRP server explorers
NNRP no permission clients
NNRP gethostbyaddr failures
NNRP client timeouts
Newsgroup request counts (by category)
Newsgroup request counts (by newsgroup)

First 5 / 55 lines (9.1%)
Jul 22 03:13:11 andromeda expireover[9354]: OVDB: expiregroup: recounting alt.binaries.multimedia
Jul 22 03:19:11 andromeda expireover[9354]: OVDB: expiregroup: recounting alt.binaries.pictures.erotica
Jul 22 03:39:10 andromeda expireover[9354]: OVDB: expiregroup: recounting misc.test
Jul 22 03:59:01 andromeda expireover[9354]: OVDB: expiregroup: recounting soc.culture.usa
Jul 22 04:17:04 andromeda expireover[9354]: OVDB: expiregroup: recounting alt.binaries.misc

Log entries by program:

Program name	Lines	%Lines	Size	%Size

inn	2177712	98.1%	192.4 MB	97.4%
nnrpd	24339	1.1%	2.5 MB	1.3%
innd	15311	0.7%	2.2 MB	1.1%
cnfsstat	2304	0.1%	404.7 KB	0.2%
expireover	55	0.0%	6.8 KB	0.0%

TOTAL: 5	2219721	100.0%	197.5 MB	100.0%

History cache:

Reason	Count	%Count

Do not exist	2167445	97.8%
Negative hits	41919	1.9%
Cache misses	3441	0.2%
Positive hits	2385	0.1%

TOTAL: 4	2215190	100.0%

INND timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)

article cancel	00:03:57.870	0.3%	17841	0.000	13.333	813.667
article cleanup	00:00:34.689	0.0%	2155175	0.007	0.016	0.027
article logging	00:02:30.982	0.2%	2160662	0.004	0.070	4.533
article parse	00:22:34.096	1.6%	176405651	0.005	0.008	0.015
article write	08:56:32.362	37.2%	2133254	4.317	15.091	50.098
artlog/artcncl	00:00:04.421	0.0%	17668	0.000	0.250	177.000
artlog/artparse	00:00:00.000	0.0%	33	0.000	0.000	0.000
data move	00:06:11.211	0.4%	186674925	0.002	0.002	0.003
hisgrep/artcncl	00:03:44.976	0.3%	5676	0.000	39.636	1154.000
hishave/artcncl	00:00:05.104	0.0%	17841	0.000	0.286	722.000
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	00:19:35.663	1.4%	2198904	0.001	0.535	10.210
history sync	00:00:00.323	0.0%	291	0.000	1.110	2.000
history write	01:02:52.014	4.4%	2133254	0.034	1.768	15.709
hiswrite/artcncl	00:00:03.209	0.0%	12165	0.000	0.264	364.000
idle	08:06:08.046	33.7%	166864517	0.120	0.175	0.599
nntp read	00:25:41.939	1.8%	175012947	0.007	0.009	0.016
overview write	03:55:57.685	16.4%	2133254	1.092	6.637	380.741
perl filter	00:00:00.000	0.0%	0	0.000	0.000	0.000
python filter	00:00:00.000	0.0%	0	0.000	0.000	0.000
site send	00:00:00.000	0.0%	0	0.000	0.000	0.000

TOTAL: 24:00:25.094	23:26:34.590	97.7%	-	-	-	-

nnrpd timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)

hisgrep	00:15:42.979	1.0%	24547	0.000	38.415	61.292
idle	23:49:48.913	93.5%	61087	0.000	1404.373	200235.000
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:36:26.446	2.4%	475841	0.000	4.595	7793.821
readart	00:18:39.904	1.2%	50507	0.000	22.173	785.000

TOTAL: 25:29:15.017	25:00:38.242	98.1%	-	-	-	-

Control commands to INND:

Command	Number

flush	144
flushlogs	1
paused	2

TOTAL: 3	147

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed

1	192.168.33.37	413	2139989	2118016	62	21911	98%	470:21:39

TOTAL: 1		413	2139989	2118016	62	21911	98%	470:21:39

Incoming Volume (INN):

Server		AcceptVol	DupVol	TotalVol	%Acc	Vol/Art	Elapsed

1	192.168.33.37	412.7 GB	5.0 MB	412.7 GB	99%	202.2 KB	470:21:39

TOTAL: 1		412.7 GB	5.0 MB	412.7 GB	99%	202.2 KB	470:21:39

Incoming articles:

Date	Articles	%Arts	Art/sec	Size	%Size	KB/sec

Jul 22 03:00:07 - 03:59:59	87683	4.1%	24.40	17.0 GB	4.1%	4948.71
Jul 22 04:00:00 - 04:59:59	89764	4.2%	24.93	17.6 GB	4.3%	5116.45
Jul 22 05:00:00 - 05:59:59	89827	4.2%	24.95	17.8 GB	4.3%	5197.15
Jul 22 06:00:00 - 06:59:59	90876	4.3%	25.24	18.2 GB	4.4%	5310.06
Jul 22 07:00:00 - 07:59:59	84245	4.0%	23.40	16.5 GB	4.0%	4809.45
Jul 22 08:00:00 - 08:59:59	88598	4.2%	24.61	18.3 GB	4.4%	5332.76
Jul 22 09:00:00 - 09:59:59	85980	4.0%	23.88	17.7 GB	4.3%	5142.39
Jul 22 10:00:00 - 10:59:59	87549	4.1%	24.32	16.4 GB	4.0%	4782.34
Jul 22 11:00:00 - 11:59:59	87171	4.1%	24.21	17.8 GB	4.3%	5195.21
Jul 22 12:00:00 - 12:59:59	86943	4.1%	24.15	17.3 GB	4.2%	5030.71
Jul 22 13:00:00 - 13:59:59	90752	4.3%	25.21	16.1 GB	3.9%	4696.54
Jul 22 14:00:00 - 14:59:59	91074	4.3%	25.30	17.6 GB	4.3%	5134.02
Jul 22 15:00:00 - 15:59:59	86727	4.1%	24.09	16.6 GB	4.0%	4825.03
Jul 22 16:00:00 - 16:59:59	87900	4.1%	24.42	16.2 GB	3.9%	4723.18
Jul 22 17:00:00 - 17:59:59	85676	4.0%	23.80	16.8 GB	4.1%	4880.28
Jul 22 18:00:00 - 18:59:59	87956	4.1%	24.43	17.2 GB	4.2%	5008.25
Jul 22 19:00:00 - 19:59:59	86897	4.1%	24.14	17.1 GB	4.2%	4992.11
Jul 22 20:00:00 - 20:59:59	87515	4.1%	24.31	16.8 GB	4.1%	4882.73
Jul 22 21:00:00 - 21:59:59	88680	4.2%	24.63	16.8 GB	4.1%	4898.81
Jul 22 22:00:00 - 22:59:59	91382	4.3%	25.38	17.3 GB	4.2%	5052.74
Jul 22 23:00:00 - 23:59:59	92738	4.3%	25.76	17.3 GB	4.2%	5037.21
Jul 23 00:00:00 - 00:59:59	89155	4.2%	24.77	15.9 GB	3.9%	4631.24
Jul 23 01:00:00 - 01:59:59	87513	4.1%	24.31	16.5 GB	4.0%	4807.99
Jul 23 02:00:00 - 02:59:59	99896	4.7%	27.75	18.8 GB	4.6%	5469.39
Jul 23 03:00:00 - 03:00:05	120	0.0%	24.00	17.7 MB	0.0%	3619.94

TOTAL: 23:59:58	2132617	100.0%	24.68	411.6 GB	100.0%	4995.96

CNFS buffer status:

Buffer	Class	Size	Used	%Used	Cycles	KB/sec	Days

01	BIN	137.8 GB	21.5 GB	15.6%	50	808.40	2.07
02	BIN	137.8 GB	23.7 GB	17.2%	50	828.49	2.02
03	SMALL	13.0 GB	12.4 GB	95.0%	2	3.60	43.91
04	BIN	80.1 GB	11.4 GB	14.2%	27	419.01	2.32
05	BIN	80.1 GB	56.1 GB	70.0%	43	419.88	2.32
06	SMALL	13.0 GB	12.3 GB	94.3%	2	3.58	44.17
07	BIN	80.1 GB	10.1 GB	12.6%	27	418.12	2.32
08	BIN	80.1 GB	56.5 GB	70.5%	43	419.56	2.32
09	SMALL	13.0 GB	12.4 GB	94.8%	2	3.55	44.51
10	BIN	80.1 GB	9.5 GB	11.8%	27	418.60	2.32
11	BIN	80.1 GB	58.1 GB	72.6%	43	421.07	2.31
12	SMALL	13.0 GB	12.3 GB	94.7%	2	3.58	44.14
13	BIN	80.1 GB	9.8 GB	12.3%	27	417.28	2.33
14	BIN	80.1 GB	55.4 GB	69.1%	43	419.08	2.32

TOTAL: 14	-	968.5 GB	361.3 GB	37.3%	388	359.01	-

Sites sending bad articles:

Server		Total	Group	Dist	Duplic	Unapp	TooOld	Site	Line	Other

1	192.168.33.37	27395	21818	0	89	0	0	0	0	5488
2	?	33	0	0	0	0	0	0	0	33

TOTAL: 2		27428	21818	0	89	0	0	0	0	5521

Unwanted newsgroups [Top 20]:

Newsgroup	Count

alt.binaries.tun	1067
alt.binaries.hotrod	646
newsmon.autotest	578
alt.binaries.pictures.erotica.asian.female	512
alt.pedophilia	365
alt.binaries.pictures.bbw	345
alt.binaries.pictures.young.and.yummy	248
alt.binaries.pictures.erotica.fetish.urine	232
pedo.japanese.fetish.lolita	214
alt.binaries.pictures.fetish.urine	184
alt.prowling-for-gay-sex	180
alt.binaries.pictures.erotica.female.ejaculation	149
alt.binaries.pictures.erotica.fetish.saliva	137
alt.binaries.pictures.erotica.female.ugly	136
rss.MoreOver-RetainSector	136
alt.binaries.pictures.erotica.flashers	135
alt.binaries.pictures.erotica.transgendered	135
alt.binaries.pictures.erotica.fetish.balloons	135
alt.binaries.pictures.erotica.fetish.hairs	135
alt.binaries.pictures.erotica.india	134

TOTAL: 2065	21818

Miscellaneous innd statistics [Top 10]:

Event	Server	Number

Bad command received
	192.168.33.37	9
	TOTAL: 1	9
Including strange strings
	192.168.33.37	5487
	TOTAL: 1	5487

TOTAL: 2		5496

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed

1	keyhole.sovam.com	3	24546	878.5 MB	32	0	0	20:50:55
2	195.46.189.169	6	375	9.8 MB	4	0	0	01:16:15
3	rol83.rol.kis.ru	2	35	70.5 KB	4	0	0	00:24:16
4	ts18-a118.moscow.dial.rol.ru	3	17	517.7 KB	3	0	0	00:31:03
5	ts16-a23.moscow.dial.rol.ru	4	10	868.6 KB	1	0	0	00:07:31
6	ts18-a64.moscow.dial.rol.ru	2	7	37.9 KB	6	0	0	00:15:01
7	194.154.66.78	2	1	31.1 KB	2	0	0	00:20:24
8	ts4-a109.nnovgorod.dial.rol.ru	1	1	7.8 KB	7	0	0	00:01:27

TOTAL: 8		23	24992	889.7 MB	59	0	0	25:28:42

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed

1	*.sovam.com	3	24546	878.5 MB	32	0	0	20:50:55
2	unresolved	12	376	9.8 MB	6	0	0	02:20:23
3	*.rol.kis.ru	7	35	70.5 KB	4	0	0	00:26:04
4	*.moscow.dial.rol.ru	31	34	1.4 MB	10	0	0	01:03:16
5	*.nnovgorod.dial.rol.ru	3	1	7.8 KB	7	0	0	00:02:03
6	*.sovintel.net	10	0	0.0 KB	0	0	0	00:00:09
7	*.pcs-net.net	1	0	0.0 KB	0	0	0	00:00:02
8	*.nsk.dial.rol.ru	20	0	0.0 KB	0	0	0	00:00:11
9	*.bytecity.ru	3	0	0.0 KB	0	0	0	00:00:04
10	*.tony.pp.ru	75	0	0.0 KB	0	0	0	00:01:04
11	*.voronezh.dial.rol.ru	4	0	0.0 KB	0	0	0	00:01:38
12	*.211.124.120.adsl-spb.net.rol.ru	143	0	0.0 KB	0	0	0	00:05:25
13	*.khabarovsk.dial.rol.ru	1	0	0.0 KB	0	0	0	00:12:41
14	*.rol.ru	5802	0	0.0 KB	0	0	0	00:18:02
15	*.komi.com	1	0	0.0 KB	0	0	0	00:05:19

TOTAL: 15		6116	24992	889.7 MB	59	0	0	25:28:34

NNRP total resource statistics [Top 20]:

System	User(ms)	System(ms)	Idle(ms)	Elapsed

keyhole.sovam.com	16.556	164.556	0.000	20:50:55
195.46.189.169	0.060	0.116	0.000	01:16:15
194.154.66.130	0.008	0.012	0.000	00:32:40
ts18-a118.moscow.dial.rol.ru	0.016	0.036	0.000	00:31:03
rol83.rol.kis.ru	0.032	0.012	0.000	00:24:16
194.154.66.78	0.008	0.008	0.000	00:20:24
ts18-a64.moscow.dial.rol.ru	0.016	0.020	0.000	00:15:01
ts2-a116.khabarovsk.dial.rol.ru	0.072	0.120	0.000	00:12:41
195.46.182.49	0.100	0.232	0.000	00:11:02
balancer-b.rol.ru	3.600	4.224	0.000	00:09:07
balancer-a.rol.ru	3.692	3.916	0.000	00:08:54
ts23-a7.moscow.dial.rol.ru	0.064	0.124	0.000	00:08:06
ts16-a23.moscow.dial.rol.ru	0.012	0.036	0.000	00:07:31
81.211.124.120.adsl-spb.net.rol.ru	0.436	0.624	0.000	00:05:25
main.komi.com	0.072	0.072	0.000	00:05:19
rol50.rol.kis.ru	0.016	0.040	0.000	00:01:47
ts2-a47.voronezh.dial.rol.ru	0.028	0.004	0.000	00:01:38
ts4-a109.nnovgorod.dial.rol.ru	0.004	0.000	0.000	00:01:27
?	0.004	0.028	0.000	00:01:10
net1-x-ring.tony.pp.ru	0.128	0.124	0.000	00:01:04

TOTAL: 37	25.592	175.504	0.000	25:28:42

Curious NNRP server explorers [Top 20]:

System	Conn

balancer-a.rol.ru	2903
balancer-b.rol.ru	2899
81.211.124.120.adsl-spb.net.rol.ru	143
net1-x-ring.tony.pp.ru	75
ts2-a152.nsk.dial.rol.ru	20
fw-nat.sovintel.net	10
ts24-a41.moscow.dial.rol.ru	5
rol50.rol.kis.ru	5
ts24-b31.moscow.dial.rol.ru	5
ts24-a244.moscow.dial.rol.ru	4
ts24-a67.moscow.dial.rol.ru	4
ts2-a47.voronezh.dial.rol.ru	4
ts27-a229.moscow.dial.rol.ru	3
194.154.66.130	3
news.bytecity.ru	3
ts4-a144.nnovgorod.dial.rol.ru	2
main.komi.com	1
ts2-a116.khabarovsk.dial.rol.ru	1
news.pcs-net.net	1
ts23-a7.moscow.dial.rol.ru	1

TOTAL: 21	6093

NNRP no permission clients:

System	Conn

87.245.178.164	25
cornholio.migtel.ru	13
195.28.36.242	1
83.220.64.71	1
83.220.64.69	1
83.220.64.16	1
pppoe-238.13.110.89-adsl.spbnit.ru	1

TOTAL: 7	43

NNRP gethostbyaddr failures [Top 20]:

System	Conn

? (can't getpeername)	20

TOTAL: 1	20

NNRP client timeouts [Top 20]:

System	Conn	Peer

194.154.66.130	3	0
rol83.rol.kis.ru	2	0
194.154.66.78	2	0
195.46.189.169	2	0
ts2-a116.khabarovsk.dial.rol.ru	1	0
ts18-a64.moscow.dial.rol.ru	1	0
195.46.182.49	1	0

TOTAL: 7	12	0

Newsgroup request counts (by category):

Category		Count	Pct

1	alt	21018	99.8%
2	relcom	35	0.2%
3	fido7	2	0.0%

TOTAL: 3		21055	100.0%

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

Newsgroup		Count

1	alt.binaries.pictures.bikini.central	4898
2	alt.binaries.pictures.bras	4699
3	alt.binaries.pictures.aviation	4637
4	alt.binaries.pictures.artpics	2599
5	alt.binaries.pictures.animals	2551
6	alt.binaries.pictures.art.pin-up	756
7	alt.binaries.pictures.anime	409
8	alt.bainaries.pictures.groupsex	365
9	alt.binaries.pictures.automobile	60
10	relcom.wheels	35
11	alt.binaries.pictures.erotica.russian	13
12	alt.binaries.pictures.erotica.alt.sex.pictures	10
13	alt.binaires.pictures.erotica.teen.female	10
14	alt.sex.zoophile	5
15	alt.binaries.sex	3
16	alt.binaries.pictures.erotica.mclt	1
17	fido7.su.magic	1
18	alt.sex.zoophilia	1
19	alt.delphinic-zoophile	1
20	fido7.ru.aviation	1

TOTAL: 20		21055