Daily Usenet report

Sep 13 03:00:02 -- Sep 14 03:00:03

Log entries by program
History cache
INND timer
nnrpd timer
Control commands to INND
Control Channel
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 / 115 lines (4.3%)
Sep 13 04:40:12 perseus controlchan[28453]: Unknown "cmsg" control by Honglian.bbs@bbs.wretch.cc
Sep 13 04:50:15 perseus controlchan[28453]: Unknown "cmsg" control by exssperion.bbs@bbs.wretch.cc
Sep 13 04:50:15 perseus controlchan[28453]: Unknown "cmsg" control by carrot11xc24.bbs@bbs.wretch.cc
Sep 13 05:50:14 perseus controlchan[28453]: Unknown "cmsg" control by Tsairong.bbs@bbs.wretch.cc
Sep 13 05:50:16 perseus controlchan[28453]: Unknown "cmsg" control by Tsairong.bbs@bbs.wretch.cc

Log entries by program:

Program name	Lines	%Lines	Size	%Size

inn	2291153	97.8%	202.4 MB	97.3%
innd	26741	1.1%	3.2 MB	1.5%
nnrpd	21752	0.9%	2.1 MB	1.0%
cnfsstat	2304	0.1%	398.1 KB	0.2%
controlchan	121	0.0%	13.4 KB	0.0%

TOTAL: 5	2342071	100.0%	208.1 MB	100.0%

History cache:

Reason	Count	%Count

Do not exist	2277308	97.7%
Negative hits	46212	2.0%
Positive hits	5145	0.2%
Cache misses	1734	0.1%

TOTAL: 4	2330399	100.0%

INND timer:

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

article cancel	00:01:31.114	0.1%	17182	0.000	5.303	968.000
article cleanup	00:00:25.397	0.0%	2260973	0.002	0.011	0.021
article logging	00:02:00.890	0.1%	2273413	0.004	0.053	3.408
article parse	00:19:31.576	1.4%	162636381	0.002	0.007	0.028
article write	10:26:15.876	43.5%	2232940	0.913	16.828	27.488
artlog/artcncl	00:00:00.208	0.0%	16708	0.000	0.012	6.750
artlog/artparse	00:00:00.001	0.0%	58	0.000	0.017	1.000
data move	00:03:46.764	0.3%	172238660	0.000	0.001	0.003
hisgrep/artcncl	00:01:14.378	0.1%	6324	0.000	11.761	968.000
hishave/artcncl	00:00:05.847	0.0%	17182	0.000	0.340	854.000
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	00:29:21.475	2.0%	2314272	0.000	0.761	14.449
history sync	00:00:00.319	0.0%	291	0.000	1.096	2.000
history write	00:57:41.671	4.0%	2232940	0.029	1.550	12.215
hiswrite/artcncl	00:00:10.561	0.0%	10858	0.000	0.973	27.000
idle	06:39:02.992	27.7%	152100190	0.127	0.157	28.814
nntp read	00:21:21.380	1.5%	160852609	0.002	0.008	0.023
overview write	04:16:48.540	17.8%	2232940	0.859	6.901	103.916
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.001	0.0%	113	0.000	0.009	0.100

TOTAL: 23:59:33.704	23:39:18.990	98.6%	-	-	-	-

nnrpd timer:

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

hisgrep	00:13:12.966	0.4%	34837	0.000	22.762	49.224
idle	49:43:24.285	96.4%	82995	0.000	2156.808	200785.667
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:25:33.148	0.8%	597274	0.000	2.567	5876.100
readart	00:32:58.110	1.1%	71422	0.000	27.696	358.000

TOTAL: 51:33:19.834	50:55:08.509	98.8%	-	-	-	-

Control commands to INND:

Command	Number

flush	144
flushlogs	1
paused	2

TOTAL: 3	147

Control Channel:

Sender	newgroup	rmgroup	Other	Bad PGP	DoIt	OK

antgirth@gmail.com	2	0	0	0	0	2
defence@alt-comp-config.at	1	0	0	0	0	1
hamstermumke@xs4all.nl	0	1	0	0	0	1
newsgroups@news.uwaterloo.ca	1	1	0	0	0	2

TOTAL	4	2	0	0	0	6

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed

1	192.168.33.37	322	2265045	2233768	8	31269	98%	472:15:45

TOTAL: 1		322	2265045	2233768	8	31269	98%	472:15:45

Incoming Volume (INN):

Server		AcceptVol	DupVol	TotalVol	%Acc	Vol/Art	Elapsed

1	192.168.33.37	418.3 GB	4.3 MB	418.3 GB	99%	193.6 KB	472:15:45

TOTAL: 1		418.3 GB	4.3 MB	418.3 GB	99%	193.6 KB	472:15:45

Incoming articles:

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

Sep 13 03:00:02 - 03:59:59	89914	4.0%	24.99	17.5 GB	4.2%	5100.19
Sep 13 04:00:00 - 04:59:59	90589	4.1%	25.16	18.0 GB	4.3%	5252.40
Sep 13 05:00:00 - 05:59:59	87476	3.9%	24.30	17.6 GB	4.2%	5127.60
Sep 13 06:00:00 - 06:59:59	82749	3.7%	22.99	15.7 GB	3.8%	4568.64
Sep 13 07:00:00 - 07:59:59	88528	4.0%	24.59	16.4 GB	3.9%	4774.14
Sep 13 08:00:00 - 08:59:59	84376	3.8%	23.44	16.4 GB	3.9%	4784.82
Sep 13 09:00:00 - 09:59:59	88314	4.0%	24.53	16.7 GB	4.0%	4854.54
Sep 13 10:00:00 - 10:59:59	88240	4.0%	24.51	17.7 GB	4.3%	5165.30
Sep 13 11:00:00 - 11:59:59	94567	4.2%	26.27	18.0 GB	4.3%	5252.32
Sep 13 12:00:00 - 12:59:59	99226	4.4%	27.56	18.9 GB	4.5%	5498.96
Sep 13 13:00:00 - 13:59:59	99094	4.4%	27.53	18.7 GB	4.5%	5435.87
Sep 13 14:00:00 - 14:59:59	100063	4.5%	27.80	18.5 GB	4.4%	5379.75
Sep 13 15:00:00 - 15:59:59	100211	4.5%	27.84	18.7 GB	4.5%	5441.92
Sep 13 16:00:00 - 16:59:59	95877	4.3%	26.63	18.1 GB	4.3%	5270.80
Sep 13 17:00:00 - 17:59:59	98916	4.4%	27.48	17.8 GB	4.3%	5185.97
Sep 13 18:00:00 - 18:59:59	98487	4.4%	27.36	18.5 GB	4.4%	5399.19
Sep 13 19:00:00 - 19:59:59	102595	4.6%	28.50	18.5 GB	4.4%	5382.24
Sep 13 20:00:00 - 20:59:59	100538	4.5%	27.93	17.8 GB	4.3%	5197.28
Sep 13 21:00:00 - 21:59:59	62647	2.8%	17.40	10.0 GB	2.4%	2904.79
Sep 13 22:00:00 - 22:59:59	100739	4.5%	27.98	18.6 GB	4.5%	5412.69
Sep 13 23:00:00 - 23:59:59	101195	4.5%	28.11	18.8 GB	4.5%	5478.49
Sep 14 00:00:00 - 00:59:59	93291	4.2%	25.91	16.7 GB	4.0%	4858.89
Sep 14 01:00:00 - 01:59:59	93658	4.2%	26.02	16.4 GB	3.9%	4773.55
Sep 14 02:00:00 - 02:59:59	92430	4.1%	25.68	16.7 GB	4.0%	4864.45
Sep 14 03:00:00 - 03:00:03	140	0.0%	46.67	24.8 MB	0.0%	8460.12

TOTAL: 24:00:01	2233860	100.0%	25.85	416.7 GB	100.0%	5056.98

CNFS buffer status:

Buffer	Class	Size	Used	%Used	Cycles	KB/sec	Days

01	BIN	137.8 GB	21.2 GB	15.4%	79	845.33	1.98
02	BIN	137.8 GB	46.3 GB	33.6%	79	851.69	1.96
03	SMALL	13.0 GB	12.4 GB	95.0%	4	5.23	30.26
04	BIN	80.1 GB	70.2 GB	87.6%	48	423.26	2.30
05	BIN	80.1 GB	67.1 GB	83.7%	68	426.38	2.28
06	SMALL	13.0 GB	12.4 GB	94.8%	4	5.22	30.33
07	BIN	80.1 GB	64.7 GB	80.7%	48	421.60	2.31
08	BIN	80.1 GB	62.8 GB	78.4%	68	425.78	2.28
09	SMALL	13.0 GB	12.1 GB	92.9%	4	5.23	30.28
10	BIN	80.1 GB	60.7 GB	75.8%	48	420.24	2.31
11	BIN	80.1 GB	69.3 GB	86.5%	68	427.36	2.27
12	SMALL	13.0 GB	12.3 GB	94.5%	4	5.26	30.11
13	BIN	80.1 GB	60.1 GB	75.1%	48	420.42	2.31
14	BIN	80.1 GB	59.3 GB	74.1%	68	425.40	2.28

TOTAL: 14	-	968.5 GB	630.8 GB	65.1%	638	365.36	-

Sites sending bad articles:

Server		Total	Group	Dist	Duplic	Unapp	TooOld	Site	Line	Other

1	192.168.33.37	40481	27491	0	549	0	0	0	0	12441
2	?	58	0	0	0	0	0	0	0	58

TOTAL: 2		40539	27491	0	549	0	0	0	0	12499

Unwanted newsgroups [Top 20]:

Newsgroup	Count

alt.binaries.movie	2925
alt.binaries.oz	1068
alt.binaries.pictures.amateur.butts	798
alt.binaries.ua-r	512
allt.sex.fetish	401
pedo.japanese.fetish.lolita	270
alt.binaries.pictures.fetish.urine	229
alt.binaries.pictures.erotica.feti	225
alt.binaries.pictures.erotica.asian.female	216
alt.binaries.nonnude	204
pictures.erotica.lesbians	203
alt.binaries.pictures.latina	197
alt.binaries.pictures.erotica.fetish.urine	189
alt.binaries.amateur.gangbang	188
alt.binaries.erotica.urine	185
alt.binaries.	180
ccu.bbs.talk.market	174
alt.binaries.mpeg.tool-time.deutsch	163
alt.sex.telephone.alt.sex.wanted	158
lada.weapon	145

TOTAL: 2954	27491

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	12441
	TOTAL: 1	12441

TOTAL: 2		12450

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed

1	keyhole.sovam.com	6	34772	1.4 GB	18	0	0	24:04:22
2	ts1-a144.saratov.dial.rol.ru	1	79	160.8 KB	1	0	0	01:16:43
3	ts1-b203.saratov.dial.rol.ru	2	24	1.3 MB	1	0	0	00:21:02
4	ts23-b210.moscow.dial.rol.ru	2	11	858.3 KB	1	0	0	00:11:55
5	ts23-a98.moscow.dial.rol.ru	1	9	332.9 KB	1	0	0	00:02:30
6	ts2-b53.syktyvkar.dial.rol.ru	14	9	493.5 KB	2	0	0	00:24:24
7	ts1-a172.saratov.dial.rol.ru	1	9	19.1 KB	1	0	0	00:50:09
8	ts1-a139.saratov.dial.rol.ru	1	5	10.5 KB	1	0	0	00:06:18
9	ts2-a230.syktyvkar.dial.rol.ru	5	2	181.0 KB	2	0	0	00:00:49
10	ts24-b149.moscow.dial.rol.ru	22	1	10.1 KB	1	0	0	00:04:49
11	adsl-195.218.206.168.ranetka.ru	2	1	1.4 KB	12	0	0	00:09:41

TOTAL: 11		57	34922	1.4 GB	41	0	2	51:32:02

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed

1	*.sovam.com	6	34772	1.4 GB	18	0	0	24:04:22
2	*.saratov.dial.rol.ru	5	117	1.5 MB	4	0	0	02:34:14
3	*.moscow.dial.rol.ru	60	21	1.2 MB	3	0	0	00:32:31
4	*.syktyvkar.dial.rol.ru	19	11	674.5 KB	4	0	0	00:25:14
5	*.218.206.168.ranetka.ru	2	1	1.4 KB	12	0	0	00:09:41
6	*.sovintel.net	28	0	0.0 KB	0	0	0	00:00:51
7	*.spb.dial.rol.ru	4	0	0.0 KB	0	0	0	00:00:02
8	*.lek.ru	1	0	0.0 KB	0	0	0	00:00:11
9	*.nnovgorod.dial.rol.ru	4	0	0.0 KB	0	0	0	00:00:41
10	*.lavtech.ru	1	0	0.0 KB	0	0	1	00:00:00
11	*.nsk.dial.rol.ru	39	0	0.0 KB	0	0	0	00:00:34
12	*.dynadsl.kis.ru	5	0	0.0 KB	0	0	0	00:00:16
13	*.239.227.211.adsl-spb.net.rol.ru	1	0	0.0 KB	0	0	0	00:00:03
14	unresolved	142	0	0.0 KB	0	0	0	23:08:55
15	*.tony.pp.ru	144	0	0.0 KB	0	0	0	00:06:04
16	*.voronezh.dial.rol.ru	1	0	0.0 KB	0	0	0	00:00:01
17	*.rol.ru	5819	0	0.0 KB	0	0	0	00:20:23
18	*.nn.ru	135	0	0.0 KB	0	0	0	00:00:26
19	*.komi.com	1	0	0.0 KB	0	0	0	00:05:09

TOTAL: 19		6417	34922	1.4 GB	41	0	1	51:31:40

NNRP total resource statistics [Top 20]:

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

keyhole.sovam.com	21.472	186.324	0.000	24:04:22
194.154.66.131	0.220	0.244	0.000	22:59:45
ts1-a144.saratov.dial.rol.ru	0.064	0.160	0.000	01:16:43
ts1-a172.saratov.dial.rol.ru	0.048	0.068	0.000	00:50:09
ts2-b53.syktyvkar.dial.rol.ru	0.048	0.116	0.000	00:24:24
ts1-b203.saratov.dial.rol.ru	0.076	0.052	0.000	00:21:02
ts23-b210.moscow.dial.rol.ru	0.004	0.008	0.000	00:11:55
ts28-b130.moscow.dial.rol.ru	0.000	0.012	0.000	00:10:35
balancer-b.rol.ru	3.636	3.660	0.000	00:10:34
balancer-a.rol.ru	3.572	3.588	0.000	00:09:49
adsl-195.218.206.168.ranetka.ru	0.016	0.008	0.000	00:09:41
213.142.208.133	0.156	0.124	0.000	00:09:10
ts1-a139.saratov.dial.rol.ru	0.004	0.004	0.000	00:06:18
net1-x-ring.tony.pp.ru	0.228	0.244	0.000	00:06:04
main.komi.com	0.076	0.040	0.000	00:05:09
ts24-b149.moscow.dial.rol.ru	0.044	0.028	0.000	00:04:49
ts23-a98.moscow.dial.rol.ru	0.004	0.008	0.000	00:02:30
?	0.024	0.044	0.000	00:01:52
ts18-a33.moscow.dial.rol.ru	0.008	0.004	0.000	00:01:23
ts24-a219.moscow.dial.rol.ru	0.032	0.020	0.000	00:00:58

TOTAL: 41	30.876	195.944	0.000	51:32:02

Curious NNRP server explorers [Top 20]:

System	Conn

balancer-b.rol.ru	2920
balancer-a.rol.ru	2899
net1-x-ring.tony.pp.ru	144
194.154.66.131	139
gray.nn.ru	135
ts2-a189.nsk.dial.rol.ru	39
fw-nat.sovintel.net	28
ts24-a219.moscow.dial.rol.ru	20
ts18-a33.moscow.dial.rol.ru	7
ts23-b155.moscow.dial.rol.ru	6
dyn-21-174.dynadsl.kis.ru	5
ts5-b159.spb.dial.rol.ru	4
ts3-b27.nnovgorod.dial.rol.ru	4
213.142.208.133	3
ts28-b130.moscow.dial.rol.ru	2
main.komi.com	1
news.lek.ru	1
ts3-a25.voronezh.dial.rol.ru	1
195.239.227.211.adsl-spb.net.rol.ru	1
ns1.lavtech.ru	1

TOTAL: 20	6360

NNRP no permission clients:

System	Conn

cornholio.migtel.ru	129
87.245.178.164	24
ppp145-58.dialup.mtu-net.ru	10
host-215-145-66-217.spbmts.ru	3
ppp83-237-250-144.pppoe.mtu-net.ru	3
83.220.64.39	1
195.28.36.242	1
213.243.85.50	1
matona.gns.ru	1

TOTAL: 9	173

NNRP gethostbyaddr failures [Top 20]:

System	Conn

? (can't getpeername)	38

TOTAL: 1	38

NNRP client timeouts [Top 20]:

System	Conn	Peer

194.154.66.131	7	0
ts2-b53.syktyvkar.dial.rol.ru	2	0
ts28-b130.moscow.dial.rol.ru	1	0
213.142.208.133	1	0
ts1-b203.saratov.dial.rol.ru	1	0
ts1-a144.saratov.dial.rol.ru	1	0

TOTAL: 6	13	0

Newsgroup request counts (by category):

Category		Count	Pct

1	alt	34781	99.7%
2	fido7	93	0.3%

TOTAL: 2		34874	100.0%

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

Newsgroup		Count

1	alt.binaries.pictures.erotica.vintage	27552
2	alt.binaries.pictures.artpics	4134
3	alt.binaries.pictures.bras	3038
4	fido7.ru.linux	93
5	alt.binares.pictures.erotica.female	24
6	alt.binaries.pictures.lolita	20
7	alt.binaries.nospam.female.bodyhair	6
8	alt.binaries.nospam.female.bodyhair.pubes	5
9	alt.languages.russian	1
10	alt.politics.socialism.libertarian	1

TOTAL: 10		34874