Daily Usenet report

Jul 16 03:00:01 -- Jul 17 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
Rnews connections rejected
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 / 18 lines (27.8%)
Jul 16 04:46:50 perseus controlchan[23637]: Unknown "cmsg" control by lilly.bbs@alexbbs.twbbs.org
Jul 16 07:10:04 perseus controlchan[23637]: Unknown "cmsg" control by orange0311.bbs@bbs.cs.nctu.edu.tw
Jul 16 07:43:00 perseus controlchan[23637]: Unknown "cmsg" control by jialong.bbs@bbs.cv.nctu.edu.tw
Jul 16 09:15:02 perseus controlchan[23637]: Unknown "cmsg" control by patmuffin.bbs@bbs.cs.nctu.edu.tw
Jul 16 10:10:05 perseus controlchan[23637]: Unknown "cmsg" control by mod86.bbs@bbs.cs.nctu.edu.tw

Log entries by program:

Program name	Lines	%Lines	Size	%Size

inn	702417	88.1%	65.0 MB	88.7%
innd	74578	9.3%	6.3 MB	8.6%
nnrpd	18370	2.3%	1.6 MB	2.2%
cnfsstat	2304	0.3%	394.1 KB	0.5%
rnews	22	0.0%	2.0 KB	0.0%
controlchan	19	0.0%	1.6 KB	0.0%

TOTAL: 6	797710	100.0%	73.3 MB	100.0%

History cache:

Reason	Count	%Count

Do not exist	641726	94.2%
Negative hits	36181	5.3%
Positive hits	2568	0.4%
Cache misses	581	0.1%

TOTAL: 4	681056	100.0%

INND timer:

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

article cancel	00:00:31.492	0.0%	5739	0.000	5.487	1321.000
article cleanup	00:00:06.083	0.0%	639377	0.000	0.010	0.031
article logging	00:01:32.630	0.1%	696756	0.000	0.133	28.881
article parse	00:02:44.784	0.2%	37971602	0.002	0.004	0.021
article write	00:58:04.749	4.0%	568294	0.430	6.132	348.732
artlog/artcncl	00:00:00.042	0.0%	5587	0.000	0.008	1.000
artlog/artparse	00:00:00.000	0.0%	1	0.000	0.000	0.000
data move	00:00:42.167	0.0%	40384733	0.000	0.001	0.005
hisgrep/artcncl	00:00:10.891	0.0%	3093	0.000	3.521	835.500
hishave/artcncl	00:00:08.983	0.0%	5739	0.000	1.565	485.500
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	00:19:48.433	1.4%	675573	0.000	1.759	32.336
history sync	00:00:00.290	0.0%	424	0.000	0.684	4.000
history write	00:36:19.517	2.5%	568294	0.010	3.835	86.459
hiswrite/artcncl	00:00:11.538	0.0%	2646	0.000	4.361	698.000
idle	20:11:24.475	84.1%	37605885	0.318	1.933	60005.000
nntp read	00:03:15.790	0.2%	37957573	0.000	0.005	0.028
overview write	01:39:54.669	6.9%	568294	0.835	10.549	140.945
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%	19	0.000	0.000	0.000

TOTAL: 23:59:39.641	23:54:56.533	99.7%	-	-	-	-

nnrpd timer:

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

hisgrep	00:00:44.118	0.1%	15599	0.000	2.828	11.234
idle	12:42:39.885	94.6%	37891	0.000	1207.672	200379.333
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:24:50.799	3.1%	166798	0.000	8.938	4335.691
readart	00:05:23.975	0.7%	31456	0.000	10.299	186.860

TOTAL: 13:26:25.175	13:13:38.777	98.4%	-	-	-	-

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

control-microsoft@trigofacile.com	1	0	0	0	0	1

TOTAL	1	0	0	0	0	1

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed

1	192.168.33.37	574	644745	575750	3	68992	89%	417:05:37

TOTAL: 1		574	644745	575750	3	68992	89%	417:05:37

Incoming Volume (INN):

Server		AcceptVol	DupVol	TotalVol	%Acc	Vol/Art	Elapsed

1	192.168.33.37	52.4 GB	121.3 KB	52.4 GB	99%	85.3 KB	417:05:37

TOTAL: 1		52.4 GB	121.3 KB	52.4 GB	99%	85.3 KB	417:05:37

Incoming articles:

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

Jul 16 03:00:01 - 03:59:59	23599	4.2%	6.56	2.6 GB	5.0%	748.66
Jul 16 04:00:00 - 04:59:59	23252	4.1%	6.46	2.8 GB	5.5%	819.39
Jul 16 05:00:00 - 05:59:59	22937	4.0%	6.37	2.4 GB	4.8%	706.61
Jul 16 06:00:00 - 06:59:59	22203	3.9%	6.17	2.7 GB	5.2%	775.57
Jul 16 07:00:00 - 07:59:59	20295	3.6%	5.64	2.5 GB	5.0%	742.05
Jul 16 08:00:00 - 08:59:59	21344	3.8%	5.93	2.6 GB	5.2%	768.39
Jul 16 09:00:00 - 09:59:59	22728	4.0%	6.31	2.6 GB	5.1%	756.34
Jul 16 10:00:00 - 10:59:59	5451	1.0%	1.51	642.0 MB	1.2%	182.60
Jul 16 11:00:00 - 11:59:59	0	0.0%	0.00	0.0 KB	0.0%	0.00
Jul 16 12:00:00 - 12:59:59	32698	5.8%	9.08	2.4 GB	4.6%	686.85
Jul 16 13:00:00 - 13:59:59	23158	4.1%	6.43	2.2 GB	4.3%	637.14
Jul 16 14:00:00 - 14:59:59	30087	5.3%	8.36	2.2 GB	4.3%	645.26
Jul 16 15:00:00 - 15:59:59	22091	3.9%	6.14	2.2 GB	4.3%	634.41
Jul 16 16:00:00 - 16:59:59	28682	5.0%	7.97	2.3 GB	4.5%	671.26
Jul 16 17:00:00 - 17:59:59	24659	4.3%	6.85	2.3 GB	4.5%	674.51
Jul 16 18:00:00 - 18:59:59	26539	4.7%	7.37	2.6 GB	5.1%	751.76
Jul 16 19:00:00 - 19:59:59	24738	4.4%	6.87	2.3 GB	4.5%	674.41
Jul 16 20:00:00 - 20:59:59	26193	4.6%	7.28	2.1 GB	4.1%	613.26
Jul 16 21:00:00 - 21:59:59	27027	4.8%	7.51	2.7 GB	5.2%	774.20
Jul 16 22:00:00 - 22:59:59	30823	5.4%	8.56	2.4 GB	4.7%	694.07
Jul 16 23:00:00 - 23:59:59	29062	5.1%	8.07	2.3 GB	4.6%	682.74
Jul 17 00:00:00 - 00:59:59	20216	3.6%	5.62	1.0 GB	2.1%	305.47
Jul 17 01:00:00 - 01:59:59	34182	6.0%	9.49	1.2 GB	2.4%	358.93
Jul 17 02:00:00 - 02:59:59	26375	4.6%	7.33	1.9 GB	3.7%	550.03
Jul 17 03:00:00 - 03:00:02	16	0.0%	8.00	484.4 KB	0.0%	242.22

TOTAL: 24:00:01	568355	100.0%	6.58	51.0 GB	100.0%	618.90

CNFS buffer status:

Buffer	Class	Size	Used	%Used	Cycles	KB/sec	Days

01	BIN	137.8 GB	117.2 GB	85.1%	211	107.80	15.52
02	BIN	137.8 GB	74.1 GB	53.8%	212	107.55	15.55
03	SMALL	13.0 GB	2.8 GB	21.3%	16	6.25	25.32
04	BIN	80.1 GB	10.4 GB	13.0%	163	54.34	17.89
05	BIN	80.1 GB	37.1 GB	46.3%	183	54.17	17.94
06	SMALL	13.0 GB	2.8 GB	21.2%	16	6.32	25.02
07	BIN	80.1 GB	68.9 GB	86.1%	162	53.88	18.04
08	BIN	80.1 GB	17.7 GB	22.1%	183	54.29	17.90
09	SMALL	13.0 GB	1.7 GB	13.0%	16	6.30	25.10
10	BIN	80.1 GB	53.3 GB	66.6%	162	54.11	17.97
11	BIN	80.1 GB	57.9 GB	72.4%	183	53.87	18.04
12	SMALL	13.0 GB	2.5 GB	19.2%	16	6.22	25.44
13	BIN	80.1 GB	50.3 GB	62.8%	162	54.31	17.90
14	BIN	80.1 GB	18.9 GB	23.6%	183	54.42	17.86

TOTAL: 14	-	968.5 GB	515.7 GB	53.2%	1868	48.20	-

Sites sending bad articles:

Server		Total	Group	Dist	Duplic	Unapp	TooOld	Site	Line	Other

1	192.168.33.37	128474	42632	0	54	0	0	0	0	85788
2	?	1	0	0	0	0	0	0	0	1

TOTAL: 2		128475	42632	0	54	0	0	0	0	85789

Unwanted newsgroups [Top 20]:

Newsgroup	Count

alt.binaries.pictures.amateur.butts	2458
microsoft.public.test	1161
alt.binaries.picture.ls-series	1134
alt.binaries.ls	1111
alt.binaries.movies.dutch.repost	771
alt.binaries.cooking	663
alt.binaries.amazing	479
hetnet.hk	383
alt.binaries.dvdrs.pw	363
alt.binaries.game	322
alt.binaries.pictures.senior-citizens	302
alt.binaries.pictures.eroctica.butts	300
alt.fan.teenboy	286
alt.binaries.pictures.erotica.downblouse	262
alt.binaries.pictures.black.erotica	258
adobe.reader	256
tin.it.sport.calcio	247
alt.binaires.pictures.erotica.male	244
alt.binaries.pictures.asian	231
alt.binaries.pictures.erotica.teen.male.masturbation	229

TOTAL: 3371	42632

Miscellaneous innd statistics [Top 10]:

Event	Server	Number

Including strange strings
	192.168.33.37	57390
	TOTAL: 1	57390

TOTAL: 1		57390

Rnews connections rejected:

Reason	Conn

400 No space (spool) [innwatch:36] 6944 lt 8000	22

TOTAL: 1	22

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed

1	keyhole.sovam.com	3	15599	658.0 MB	12	0	0	11:26:45
2	ts27-b81.moscow.dial.rol.ru	1	43	5.5 MB	9	0	0	00:25:54
3	195.218.244.87	2	38	4.3 MB	1	0	0	00:20:51
4	ts2-b207.syktyvkar.dial.rol.ru	2	2	3.2 KB	1	0	0	00:00:02

TOTAL: 4		8	15682	667.7 MB	23	0	2	13:26:25

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed

1	*.sovam.com	3	15599	658.0 MB	12	0	0	11:26:45
2	*.moscow.dial.rol.ru	1	43	5.5 MB	9	0	0	00:25:54
3	unresolved	2	38	4.3 MB	1	0	0	00:20:51
4	*.syktyvkar.dial.rol.ru	2	2	3.2 KB	1	0	0	00:00:02
5	*.sovintel.net	13	0	0.0 KB	0	0	0	00:00:16
6	*.net.rol.ru	1	0	0.0 KB	0	0	0	00:08:44
7	*.bryansk.dial.rol.ru	1	0	0.0 KB	0	0	0	00:14:21
8	*.sarov.dial.rol.ru	5	0	0.0 KB	0	0	0	00:31:15
9	*.tony.pp.ru	72	0	0.0 KB	0	0	0	00:02:48
10	*.rol.ru	5763	0	0.0 KB	0	0	0	00:13:59
11	*.nn.ru	5	0	0.0 KB	0	0	0	00:00:00
12	*.tr155m.lavtech.ru	1	0	0.0 KB	0	0	1	00:00:00

TOTAL: 12		5869	15682	667.7 MB	23	0	1	13:26:09

NNRP total resource statistics [Top 20]:

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

keyhole.sovam.com	10.036	106.408	0.000	11:26:45
ts27-b81.moscow.dial.rol.ru	0.012	0.032	0.000	00:25:54
195.218.244.87	0.008	0.036	0.000	00:20:51
ts2-a56.sarov.dial.rol.ru	0.016	0.000	0.000	00:20:02
ts2-a71.bryansk.dial.rol.ru	0.064	0.036	0.000	00:14:21
ts2-a234.sarov.dial.rol.ru	0.000	0.004	0.000	00:10:00
modul-gw000.net.rol.ru	0.000	0.000	0.000	00:08:44
balancer-b.rol.ru	3.464	3.272	0.000	00:07:17
balancer-a.rol.ru	3.648	3.288	0.000	00:06:42
net1-x-ring.tony.pp.ru	0.084	0.108	0.000	00:02:48
ts2-a139.sarov.dial.rol.ru	0.004	0.000	0.000	00:01:12
?	0.012	0.004	0.000	00:01:08
fw-nat.sovintel.net	0.080	0.040	0.000	00:00:16
79-126-57-206.dynamic.mts-nn.ru	0.000	0.004	0.000	00:00:15
ts2-b207.syktyvkar.dial.rol.ru	0.000	0.004	0.000	00:00:02
gray.nn.ru	0.004	0.004	0.000	00:00:00
cornholio.migtel.ru	0.028	0.052	0.000	00:00:00
web02.tr155m.lavtech.ru	0.000	0.004	0.000	00:00:00

TOTAL: 18	17.460	113.296	0.000	13:26:25

Curious NNRP server explorers [Top 20]:

System	Conn

balancer-b.rol.ru	2883
balancer-a.rol.ru	2880
net1-x-ring.tony.pp.ru	72
fw-nat.sovintel.net	13
gray.nn.ru	5
ts2-a56.sarov.dial.rol.ru	2
ts2-a139.sarov.dial.rol.ru	2
web02.tr155m.lavtech.ru	1
ts2-a234.sarov.dial.rol.ru	1
modul-gw000.net.rol.ru	1
ts2-a71.bryansk.dial.rol.ru	1

TOTAL: 11	5861

NNRP no permission clients:

System	Conn

cornholio.migtel.ru	31
79-126-57-206.dynamic.mts-nn.ru	4

TOTAL: 2	35

NNRP gethostbyaddr failures [Top 20]:

System	Conn

? (can't getpeername)	11

TOTAL: 1	11

NNRP client timeouts [Top 20]:

System	Conn	Peer

ts2-a56.sarov.dial.rol.ru	2	0
ts2-a234.sarov.dial.rol.ru	1	0
195.218.244.87	1	0
ts2-a71.bryansk.dial.rol.ru	1	0

TOTAL: 4	5	0

Newsgroup request counts (by category):

Category		Count	Pct

1	alt	14129	100.0%

TOTAL: 1		14129	100.0%

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

Newsgroup		Count

1	alt.binaries.pictures.erotica.vintage	9359
2	alt.binaries.pictures.bras	3375
3	alt.binaries.pictures.artpics	1312
4	alt.binaries.pictures.vladmodels	39
5	alt.binaries.erotica.pornstars	38
6	alt.binaries.pictures.ls-series	3
7	alt.binaries.nospam.female.bodyhair.pubes	2
8	alt.binaries.camille	1

TOTAL: 8		14129