Daily Usenet report

Sep 17 03:00:02 -- Sep 18 03:00:02

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 / 147 lines (3.4%)
Sep 17 04:50:12 perseus controlchan[28453]: Unknown "cmsg" control by puifong.bbs@bbs.wretch.cc
Sep 17 04:50:13 perseus controlchan[28453]: Unknown "cmsg" control by richard168.bbs@bbs.wretch.cc
Sep 17 04:50:13 perseus controlchan[28453]: Unknown "cmsg" control by richard168.bbs@bbs.wretch.cc
Sep 17 04:50:13 perseus controlchan[28453]: Unknown "cmsg" control by richard168.bbs@bbs.wretch.cc
Sep 17 04:50:13 perseus controlchan[28453]: Unknown "cmsg" control by richard168.bbs@bbs.wretch.cc

Log entries by program:

Program name	Lines	%Lines	Size	%Size

inn	2393232	97.7%	211.8 MB	97.1%
innd	30341	1.2%	3.5 MB	1.6%
nnrpd	23995	1.0%	2.3 MB	1.1%
cnfsstat	2304	0.1%	397.1 KB	0.2%
controlchan	151	0.0%	15.3 KB	0.0%

TOTAL: 5	2450023	100.0%	218.1 MB	100.0%

History cache:

Reason	Count	%Count

Do not exist	2374635	96.8%
Negative hits	52477	2.1%
Positive hits	21777	0.9%
Cache misses	3996	0.2%

TOTAL: 4	2452885	100.0%

INND timer:

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

article cancel	00:03:48.386	0.3%	43314	0.000	5.273	647.500
article cleanup	00:00:26.451	0.0%	2341896	0.004	0.011	0.022
article logging	00:01:55.536	0.1%	2350602	0.005	0.049	2.865
article parse	00:19:52.319	1.4%	159790286	0.005	0.007	0.019
article write	10:55:28.439	45.5%	2313714	6.000	16.998	38.827
artlog/artcncl	00:00:04.880	0.0%	42702	0.000	0.114	162.125
artlog/artparse	00:00:00.021	0.0%	56	0.000	0.375	20.000
data move	00:03:47.191	0.3%	169179031	0.001	0.001	0.002
hisgrep/artcncl	00:03:25.881	0.2%	22696	0.000	9.071	948.000
hishave/artcncl	00:00:07.499	0.0%	43314	0.000	0.173	71.565
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	00:23:06.192	1.6%	2410523	0.001	0.575	14.645
history sync	00:00:00.296	0.0%	289	0.000	1.024	2.000
history write	00:53:44.323	3.7%	2313714	0.023	1.394	12.595
hiswrite/artcncl	00:00:09.793	0.0%	20618	0.000	0.475	59.000
idle	05:46:19.956	24.0%	148605007	0.127	0.140	0.694
nntp read	00:21:35.568	1.5%	157827819	0.006	0.008	0.017
overview write	04:46:54.313	19.9%	2313714	1.244	7.440	75.790
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.003	0.0%	145	0.000	0.021	1.000

TOTAL: 24:00:03.840	23:40:47.047	98.7%	-	-	-	-

nnrpd timer:

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

hisgrep	00:23:22.682	0.9%	26002	0.000	53.945	1886.000
idle	33:02:51.451	79.2%	142259	0.000	836.302	200130.333
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	06:48:40.401	16.3%	472642	0.000	51.879	22236.522
readart	00:28:38.386	1.1%	51714	0.000	33.229	792.000

TOTAL: 41:44:41.195	40:43:32.920	97.6%	-	-	-	-

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

nyyssit@isoallo.fi	3	0	0	0	0	3
nyyssit@isoallo.net	1	0	0	0	0	1

TOTAL	4	0	0	0	0	4

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed

1	192.168.33.37	316	2279029	2253792	23	25214	98%	462:24:18

TOTAL: 1		316	2279029	2253792	23	25214	98%	462:24:18

Incoming Volume (INN):

Server		AcceptVol	DupVol	TotalVol	%Acc	Vol/Art	Elapsed

1	192.168.33.37	423.7 GB	10.9 MB	423.7 GB	99%	194.9 KB	462:24:18

TOTAL: 1		423.7 GB	10.9 MB	423.7 GB	99%	194.9 KB	462:24:18

Incoming articles:

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

Sep 17 03:00:02 - 03:59:59	98610	4.3%	27.41	19.2 GB	4.5%	5592.05
Sep 17 04:00:00 - 04:59:59	91167	3.9%	25.32	18.4 GB	4.3%	5352.47
Sep 17 05:00:00 - 05:59:59	87112	3.8%	24.20	17.8 GB	4.2%	5189.85
Sep 17 06:00:00 - 06:59:59	83257	3.6%	23.13	16.3 GB	3.9%	4754.55
Sep 17 07:00:00 - 07:59:59	87584	3.8%	24.33	17.3 GB	4.1%	5038.16
Sep 17 08:00:00 - 08:59:59	92196	4.0%	25.61	17.8 GB	4.2%	5176.39
Sep 17 09:00:00 - 09:59:59	87075	3.8%	24.19	16.7 GB	3.9%	4862.27
Sep 17 10:00:00 - 10:59:59	86699	3.7%	24.08	15.5 GB	3.7%	4508.39
Sep 17 11:00:00 - 11:59:59	91778	4.0%	25.49	17.8 GB	4.2%	5191.37
Sep 17 12:00:00 - 12:59:59	95528	4.1%	26.54	18.3 GB	4.3%	5337.23
Sep 17 13:00:00 - 13:59:59	96459	4.2%	26.79	18.3 GB	4.3%	5323.21
Sep 17 14:00:00 - 14:59:59	95649	4.1%	26.57	18.5 GB	4.4%	5398.66
Sep 17 15:00:00 - 15:59:59	98521	4.3%	27.37	18.7 GB	4.4%	5434.61
Sep 17 16:00:00 - 16:59:59	100208	4.3%	27.84	18.4 GB	4.3%	5348.86
Sep 17 17:00:00 - 17:59:59	102694	4.4%	28.53	17.8 GB	4.2%	5190.57
Sep 17 18:00:00 - 18:59:59	102562	4.4%	28.49	17.8 GB	4.2%	5173.12
Sep 17 19:00:00 - 19:59:59	102242	4.4%	28.40	17.8 GB	4.2%	5198.56
Sep 17 20:00:00 - 20:59:59	103553	4.5%	28.76	18.5 GB	4.4%	5375.09
Sep 17 21:00:00 - 21:59:59	102310	4.4%	28.42	18.4 GB	4.3%	5350.51
Sep 17 22:00:00 - 22:59:59	102814	4.4%	28.56	17.5 GB	4.1%	5110.97
Sep 17 23:00:00 - 23:59:59	101340	4.4%	28.15	17.8 GB	4.2%	5195.00
Sep 18 00:00:00 - 00:59:59	96390	4.2%	26.77	16.8 GB	4.0%	4897.22
Sep 18 01:00:00 - 01:59:59	113176	4.9%	31.44	14.6 GB	3.5%	4266.06
Sep 18 02:00:00 - 02:59:59	94592	4.1%	26.28	17.2 GB	4.1%	5014.47
Sep 18 03:00:00 - 03:00:02	72	0.0%	36.00	14.4 MB	0.0%	7359.21

TOTAL: 24:00:00	2313588	100.0%	26.78	423.3 GB	100.0%	5136.69

CNFS buffer status:

Buffer	Class	Size	Used	%Used	Cycles	KB/sec	Days

01	BIN	137.8 GB	31.5 GB	22.8%	81	826.13	2.02
02	BIN	137.8 GB	58.6 GB	42.5%	81	852.03	1.96
03	SMALL	13.0 GB	1.0 GB	7.9%	5	5.68	27.86
04	BIN	80.1 GB	53.3 GB	66.6%	50	430.08	2.26
05	BIN	80.1 GB	51.3 GB	64.0%	70	433.45	2.24
06	SMALL	13.0 GB	1.0 GB	7.7%	5	5.70	27.75
07	BIN	80.1 GB	47.3 GB	59.1%	50	428.13	2.27
08	BIN	80.1 GB	46.6 GB	58.1%	70	431.97	2.25
09	SMALL	13.0 GB	774.4 MB	5.8%	5	5.64	28.06
10	BIN	80.1 GB	43.0 GB	53.6%	50	425.97	2.28
11	BIN	80.1 GB	53.7 GB	67.0%	70	434.23	2.24
12	SMALL	13.0 GB	985.4 MB	7.4%	5	5.69	27.82
13	BIN	80.1 GB	42.3 GB	52.8%	50	426.35	2.28
14	BIN	80.1 GB	43.0 GB	53.7%	70	431.82	2.25

TOTAL: 14	-	968.5 GB	474.3 GB	49.0%	662	369.20	-

Sites sending bad articles:

Server		Total	Group	Dist	Duplic	Unapp	TooOld	Site	Line	Other

1	192.168.33.37	36886	25131	0	3050	0	0	0	0	8705
2	?	56	0	0	0	0	0	0	0	56

TOTAL: 2		36942	25131	0	3050	0	0	0	0	8761

Unwanted newsgroups [Top 20]:

Newsgroup	Count

es.binarios.hd	2402
alt.binaries.	1011
alt.binaries.pictures.amateur.butts	626
alt.binaries.pictures.bdcompany	357
ccu.bbs.talk.market	335
alt.binaries.erotica.freckles	324
alt.binaries.jerry	285
alt.binaries.erotica.erotica.bisexuals	271
alt.binaries.pictures.erotica.asian.female	252
alt.binaries.hotrod	250
alt.binaries.incest	207
pedo.japanese.fetish.lolita	164
alt.binaries.nonnude	136
alt.binaries.picture.erotica.anal	128
alt.binaries.applications	128
alt.binaries.pictures.fetish.urine	126
aol.neighborhood.ny.new-york	121
mailing.openbsd.misc	121
tmnet.communities	121
alt.binaries.pictures.eroctica.butts	111

TOTAL: 2449	25131

Miscellaneous innd statistics [Top 10]:

Event	Server	Number

Bad command received
	192.168.33.37	27
	TOTAL: 1	27
Including strange strings
	192.168.33.37	8705
	TOTAL: 1	8705

TOTAL: 2		8732

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed

1	keyhole.sovam.com	4	24139	2.5 GB	9	0	0	14:03:14
2	ts1-a41.saratov.dial.rol.ru	1126	748	50.6 MB	0	0	0	10:07:54
3	ts1-a98.saratov.dial.rol.ru	13	193	18.4 MB	0	0	0	03:42:59
4	ts2-a86.krasnoyarsk.dial.rol.ru	7	106	331.0 KB	5	0	0	00:02:18
5	ts1-a160.saratov.dial.rol.ru	1	49	99.5 KB	1	0	0	00:35:55
6	news.pcs-net.net	18	7	416.8 KB	7	0	0	02:01:21
7	ts1-a113.saratov.dial.rol.ru	1	6	12.1 KB	1	0	0	00:46:29
8	ts2-a184.syktyvkar.dial.rol.ru	4	2	177.3 KB	1	0	0	00:00:45
9	194.186.150.41	9	2	62.3 KB	0	0	0	00:02:19

TOTAL: 9		1183	25252	2.6 GB	24	0	2	45:14:19

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed

1	*.sovam.com	4	24139	2.5 GB	9	0	0	14:03:14
2	*.saratov.dial.rol.ru	1141	996	69.1 MB	2	0	0	15:13:19
3	*.krasnoyarsk.dial.rol.ru	48	106	331.0 KB	5	0	0	00:09:53
4	*.pcs-net.net	18	7	416.8 KB	7	0	0	02:01:21
5	unresolved	94	2	62.3 KB	0	0	0	12:32:58
6	*.syktyvkar.dial.rol.ru	8	2	177.3 KB	1	0	0	00:02:51
7	*.ufa.dial.rol.ru	3	0	0.0 KB	0	0	0	00:00:17
8	*.sovintel.net	12	0	0.0 KB	0	0	0	00:00:32
9	*.spb.dial.rol.ru	53	0	0.0 KB	0	0	0	00:06:51
10	*.lek.ru	1	0	0.0 KB	0	0	0	00:00:09
11	*.lavtech.ru	1	0	0.0 KB	0	0	1	00:00:01
12	*.nsk.dial.rol.ru	40	0	0.0 KB	0	0	0	00:00:42
13	*.moscow.dial.rol.ru	18	0	0.0 KB	0	0	0	00:01:55
14	*.sarov.dial.rol.ru	2	0	0.0 KB	0	0	0	00:01:56
15	*.tony.pp.ru	67	0	0.0 KB	0	0	0	00:34:13
16	*.rol.ru	5849	0	0.0 KB	0	0	0	00:21:14
17	*.nn.ru	31	0	0.0 KB	0	0	0	00:00:18

TOTAL: 17		7390	25252	2.6 GB	24	0	1	45:14:16

NNRP total resource statistics [Top 20]:

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

keyhole.sovam.com	11.772	102.078	0.000	14:03:14
194.154.66.131	0.144	0.116	0.000	12:06:45
ts1-a41.saratov.dial.rol.ru	1.688	2.512	0.000	10:07:54
ts1-a98.saratov.dial.rol.ru	0.040	0.216	0.000	03:42:59
news.pcs-net.net	0.048	0.048	0.000	02:01:21
ts1-a113.saratov.dial.rol.ru	0.040	0.072	0.000	00:46:29
ts1-a160.saratov.dial.rol.ru	0.036	0.032	0.000	00:35:55
net1-x-ring.tony.pp.ru	39.912	379.213	0.000	00:34:13
194.154.66.127	0.024	0.012	0.000	00:23:31
balancer-b.rol.ru	3.736	3.724	0.000	00:10:52
balancer-a.rol.ru	3.828	3.824	0.000	00:10:21
ts12-a74.spb.dial.rol.ru	0.240	0.328	0.000	00:06:25
ts1-a75.krasnoyarsk.dial.rol.ru	0.004	0.008	0.000	00:02:32
?	0.004	0.028	0.000	00:02:25
ts1-b165.krasnoyarsk.dial.rol.ru	0.020	0.032	0.000	00:02:22
194.186.150.41	0.016	0.016	0.000	00:02:19
ts2-a86.krasnoyarsk.dial.rol.ru	0.016	0.048	0.000	00:02:18
ts2-a147.sarov.dial.rol.ru	0.000	0.004	0.000	00:01:56
ts2-a144.syktyvkar.dial.rol.ru	0.024	0.040	0.000	00:01:46
ts1-a25.krasnoyarsk.dial.rol.ru	0.008	0.008	0.000	00:01:29

TOTAL: 47	62.092	492.803	0.000	45:14:19

Curious NNRP server explorers [Top 20]:

System	Conn

balancer-b.rol.ru	2925
balancer-a.rol.ru	2924
194.154.66.131	73
net1-x-ring.tony.pp.ru	67
ts2-b189.nsk.dial.rol.ru	40
gray.nn.ru	31
ts12-a74.spb.dial.rol.ru	23
ts1-b165.krasnoyarsk.dial.rol.ru	13
fw-nat.sovintel.net	12
ts1-b4.krasnoyarsk.dial.rol.ru	12
ts5-b227.spb.dial.rol.ru	11
194.154.66.127	10
ts24-a238.moscow.dial.rol.ru	9
ts2-a220.krasnoyarsk.dial.rol.ru	7
ts1-a25.krasnoyarsk.dial.rol.ru	7
ts5-b143.spb.dial.rol.ru	6
ts24-b34.moscow.dial.rol.ru	5
ts5-b153.spb.dial.rol.ru	5
ts5-a228.spb.dial.rol.ru	4
ts2-b73.ufa.dial.rol.ru	3

TOTAL: 32	6207

NNRP no permission clients:

System	Conn

83.234.230.178	2
ts2-a248.khabarovsk.dial.rol.ru	2
83.237.156.240	1
83.220.64.67	1
89.184.226.158	1

TOTAL: 5	7

NNRP gethostbyaddr failures [Top 20]:

System	Conn

? (can't getpeername)	45

TOTAL: 1	45

NNRP client timeouts [Top 20]:

System	Conn	Peer

news.pcs-net.net	11	0
194.154.66.131	8	0
194.154.66.127	2	0
ts1-a160.saratov.dial.rol.ru	1	0

TOTAL: 4	22	0

Newsgroup request counts (by category):

Category		Count	Pct

1	alt	25509	99.4%
2	fido7	161	0.6%

TOTAL: 2		25670	100.0%

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

Newsgroup		Count

1	alt.binaries.pictures.erotica.vintage	20186
2	alt.binaries.pictures.artpics	2758
3	alt.binaries.pictures.bras	2556
4	fido7.ru.algorithms	57
5	fido7.ru.linux	55
6	fido7.ru.math	40
7	alt.binaries.pictures.vladmodels	7
8	fido7.ru.delphi.internet	4
9	fido7.ru.delphi.chainik	3
10	alt.binaries.nospam.female.bodyhair	2
11	fido7.ru.delphi.talk	2

TOTAL: 11		25670