Daily Usenet report

Dec 23 03:00:02 -- Dec 24 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
INND misc events
Miscellaneous innd statistics
NNRP readership statistics
NNRP readership statistics (by domain)
NNRP total resource statistics
Curious NNRP server explorers
NNRP no permission clients
Newsgroup request counts (by category)
Newsgroup request counts (by newsgroup)

First 23 / 23 lines (100.0%)
Dec 23 05:25:54 andromeda controlchan[18019]: Unknown "cmsg" control by doono329.bbs@bbs.cs.nctu.edu.tw
Dec 23 06:20:04 andromeda controlchan[18019]: Unknown "cmsg" control by happypink.bbs@bbs.cs.nctu.edu.tw
Dec 23 06:59:42 andromeda controlchan[18019]: Unknown "cmsg" control by simonboy1007.bbs@bbs.cs.nctu.edu.tw
Dec 23 07:43:49 andromeda controlchan[18019]: Unknown "cmsg" control by winniliang.bbs@bbs.cs.nctu.edu.tw
Dec 23 08:49:52 andromeda controlchan[18019]: Unknown "cmsg" control by linakai.bbs@bbs.cs.nctu.edu.tw
Dec 23 09:35:35 andromeda controlchan[18019]: Unknown "cmsg" control by marlar.bbs@kulu.twbbs.org
Dec 23 10:41:08 andromeda controlchan[18019]: Unknown "cmsg" control by scsc17.bbs@bbs.math.nctu.edu.tw
Dec 23 10:58:39 andromeda controlchan[18019]: Unknown "cmsg" control by doono329.bbs@bbs.cs.nctu.edu.tw
Dec 23 11:43:05 andromeda controlchan[18019]: Unknown "cmsg" control by pollow.bbs@bbs.cs.nctu.edu.tw
Dec 23 12:14:13 andromeda controlchan[18019]: skipping rmgroup alt.usenet.peering spam@uce.gov (would be no change)
Dec 23 13:08:07 andromeda controlchan[18019]: Unknown "cmsg" control by hank6187.bbs@bbs.cs.nctu.edu.tw
Dec 23 13:08:09 andromeda controlchan[18019]: Unknown "cmsg" control by hank6187.bbs@bbs.cs.nctu.edu.tw
Dec 23 15:38:07 andromeda controlchan[18019]: Unknown "cmsg" control by Ranma.bbs@bbs.cs.nctu.edu.tw
Dec 23 15:43:07 andromeda controlchan[18019]: Unknown "cmsg" control by wing7820.bbs@bbs.cs.nctu.edu.tw
Dec 23 16:13:17 andromeda controlchan[18019]: Unknown "cmsg" control by doono329.bbs@bbs.cs.nctu.edu.tw
Dec 23 16:13:31 andromeda controlchan[18019]: Unknown "cmsg" control by doono329.bbs@bbs.cs.nctu.edu.tw
Dec 23 17:43:30 andromeda controlchan[18019]: Unknown "cmsg" control by kuwu.bbs@bbs.cs.nctu.edu.tw
Dec 23 19:13:32 andromeda controlchan[18019]: Unknown "cmsg" control by sylviax.bbs@bbs.cs.nctu.edu.tw
Dec 23 19:49:55 andromeda controlchan[18019]: Unknown "cmsg" control by happypink.bbs@bbs.cs.nctu.edu.tw
Dec 23 20:16:23 andromeda controlchan[18019]: Unknown "cmsg" control by goodsight.bbs@bbs.cs.nctu.edu.tw
Dec 23 20:19:20 andromeda controlchan[18019]: Unknown "cmsg" control by jimmy0801.bbs@bbs.cs.nctu.edu.tw
Dec 23 20:50:23 andromeda controlchan[18019]: Unknown "cmsg" control by hank6187.bbs@bbs.cs.nctu.edu.tw
Dec 24 02:23:39 andromeda controlchan[18019]: Unknown "cmsg" control by isaac1225.bbs@bbs.cs.nctu.edu.tw

Log entries by program:

Program name	Lines	%Lines	Size	%Size

inn	671623	95.2%	60.2 MB	94.0%
nnrpd	18166	2.6%	1.8 MB	2.8%
innd	13468	1.9%	1.6 MB	2.6%
cnfsstat	2304	0.3%	403.6 KB	0.6%
controlchan	26	0.0%	3.0 KB	0.0%

TOTAL: 5	705587	100.0%	64.1 MB	100.0%

History cache:

Reason	Count	%Count

Do not exist	619770	92.2%
Negative hits	28454	4.2%
Positive hits	18000	2.7%
Cache misses	6322	0.9%

TOTAL: 4	672546	100.0%

INND timer:

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

article cancel	00:00:08.928	0.0%	27544	0.000	0.324	46.429
article cleanup	00:00:07.023	0.0%	616609	0.000	0.011	0.043
article logging	00:01:00.907	0.1%	643964	0.000	0.095	10.212
article parse	00:01:29.470	0.1%	16662928	0.002	0.005	0.072
article write	00:23:11.707	1.6%	567904	0.292	2.451	13.047
artlog/artcncl	00:00:01.471	0.0%	27476	0.000	0.054	20.169
artlog/artparse	00:00:00.000	0.0%	10	0.000	0.000	0.000
data move	00:00:35.922	0.0%	18631629	0.000	0.002	0.007
hisgrep/artcncl	00:00:04.542	0.0%	23693	0.000	0.192	46.286
hishave/artcncl	00:00:01.509	0.0%	27544	0.000	0.055	46.333
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	00:05:29.973	0.4%	645272	0.000	0.511	7.083
history sync	00:00:00.379	0.0%	312	0.000	1.215	3.000
history write	00:14:10.210	1.0%	616076	0.008	1.380	15.286
hiswrite/artcncl	00:00:01.101	0.0%	3851	0.000	0.286	13.000
idle	21:34:30.538	89.9%	16586416	0.000	4.683	11.725
nntp read	00:01:41.360	0.1%	16669060	0.002	0.006	0.081
overview write	01:33:10.112	6.5%	567904	1.808	9.843	5460.833
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%	53	0.000	0.019	0.100

TOTAL: 23:59:34.850	23:55:45.153	99.7%	-	-	-	-

nnrpd timer:

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

idle	00:38:19.930	90.0%	6569	6.000	350.119	69086.737
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:03:16.688	7.7%	19468	0.000	10.103	0.000
readart	00:00:00.221	0.0%	13	0.000	17.000	0.000

TOTAL: 00:42:36.369	00:41:36.839	97.7%	-	-	-	-

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

group-admin@isc.org	1	0	0	0	1	1
newsgroups@news.uwaterloo.ca	1	0	0	0	0	1
spam@uce.gov	0	1	0	0	0	1

TOTAL	2	1	0	0	1	3

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed

1	192.168.33.37	1551	601318	552993	119	48206	91%	310:37:03

TOTAL: 1		1551	601318	552993	119	48206	91%	310:37:03

Incoming Volume (INN):

Server		AcceptVol	DupVol	TotalVol	%Acc	Vol/Art	Elapsed

1	192.168.33.37	23.1 GB	3.6 MB	23.1 GB	99%	40.2 KB	310:37:03

TOTAL: 1		23.1 GB	3.6 MB	23.1 GB	99%	40.2 KB	310:37:03

Incoming articles:

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

Dec 23 03:00:02 - 03:59:59	23108	4.1%	6.42	913.0 MB	3.9%	259.84
Dec 23 04:00:00 - 04:59:59	23219	4.1%	6.45	950.8 MB	4.1%	270.45
Dec 23 05:00:00 - 05:59:59	24113	4.2%	6.70	1005.1 MB	4.3%	285.89
Dec 23 06:00:00 - 06:59:59	22033	3.9%	6.12	1.0 GB	4.6%	305.25
Dec 23 07:00:00 - 07:59:59	17734	3.1%	4.93	831.7 MB	3.6%	236.56
Dec 23 08:00:00 - 08:59:59	19123	3.4%	5.31	922.5 MB	4.0%	262.39
Dec 23 09:00:00 - 09:59:59	21990	3.9%	6.11	933.7 MB	4.0%	265.57
Dec 23 10:00:00 - 10:59:59	19397	3.4%	5.39	827.9 MB	3.6%	235.49
Dec 23 11:00:00 - 11:59:59	20020	3.5%	5.56	789.1 MB	3.4%	224.45
Dec 23 12:00:00 - 12:59:59	20925	3.7%	5.81	829.2 MB	3.6%	235.85
Dec 23 13:00:00 - 13:59:59	22157	3.9%	6.15	939.1 MB	4.0%	267.12
Dec 23 14:00:00 - 14:59:59	23430	4.1%	6.51	993.7 MB	4.3%	282.66
Dec 23 15:00:00 - 15:59:59	29068	5.1%	8.07	1.4 GB	6.3%	414.98
Dec 23 16:00:00 - 16:59:59	25917	4.6%	7.20	933.9 MB	4.0%	265.65
Dec 23 17:00:00 - 17:59:59	20451	3.6%	5.68	804.0 MB	3.5%	228.69
Dec 23 18:00:00 - 18:59:59	24366	4.3%	6.77	887.1 MB	3.8%	252.33
Dec 23 19:00:00 - 19:59:59	21440	3.8%	5.96	855.5 MB	3.7%	243.35
Dec 23 20:00:00 - 20:59:59	44129	7.8%	12.26	1011.7 MB	4.3%	287.76
Dec 23 21:00:00 - 21:59:59	21994	3.9%	6.11	852.2 MB	3.7%	242.40
Dec 23 22:00:00 - 22:59:59	25361	4.5%	7.04	1.1 GB	5.0%	334.30
Dec 23 23:00:00 - 23:59:59	26032	4.6%	7.23	1.2 GB	5.3%	351.49
Dec 24 00:00:00 - 00:59:59	24032	4.2%	6.68	976.1 MB	4.2%	277.63
Dec 24 01:00:00 - 01:59:59	27795	4.9%	7.72	1.0 GB	4.6%	302.27
Dec 24 02:00:00 - 02:59:59	20194	3.6%	5.61	1014.1 MB	4.4%	288.45
Dec 24 03:00:00 - 03:00:02	16	0.0%	8.00	939.9 KB	0.0%	469.94

TOTAL: 24:00:00	568044	100.0%	6.57	22.7 GB	100.0%	275.87

CNFS buffer status:

Buffer	Class	Size	Used	%Used	Cycles	KB/sec	Days

01	BIN	137.8 GB	55.9 GB	40.5%	195	41.77	40.05
02	BIN	137.8 GB	94.8 GB	68.8%	195	41.63	40.18
03	SMALL	13.0 GB	6.1 GB	47.2%	19	7.73	20.48
04	BIN	80.1 GB	8.4 GB	10.5%	152	20.82	46.69
05	BIN	80.1 GB	73.6 GB	91.9%	168	20.61	47.17
06	SMALL	13.0 GB	5.6 GB	42.6%	19	7.72	20.50
07	BIN	80.1 GB	77.0 GB	96.1%	151	20.63	47.13
08	BIN	80.1 GB	56.0 GB	69.9%	168	20.83	46.67
09	SMALL	13.0 GB	5.6 GB	43.2%	19	7.82	20.23
10	BIN	80.1 GB	70.9 GB	88.5%	151	21.03	46.23
11	BIN	80.1 GB	401.4 MB	0.5%	169	20.97	46.36
12	BIN	13.0 GB	10.6 GB	81.2%	571	20.94	7.56
13	BIN	80.1 GB	33.5 GB	41.8%	93	20.82	46.69
14	SMALL	80.1 GB	21.2 GB	26.5%	2	7.83	124.15

TOTAL: 14	-	968.5 GB	519.6 GB	53.7%	2072	20.08	-

Sites sending bad articles:

Server		Total	Group	Dist	Duplic	Unapp	TooOld	Site	Line	Other

1	192.168.33.37	76100	48190	0	528	0	0	0	0	27382

TOTAL: 1		76100	48190	0	528	0	0	0	0	27382

Unwanted newsgroups [Top 20]:

Newsgroup	Count

bellsouth.net.test	2880
alt.binaries.pictures.amateur.butts	2818
microsoft.public.test	1153
alt.binaries.pwp	589
alt.binaries.pictures.erotica.early-teen	422
alt.binaries.pictures.erotica.teen.male.masturbation	367
alt.sex.teen	332
alt.binaires.pictures.erotica.teens	313
alt.binaries.pictures.erotica.voyeurism.hidden-cam	289
ntu-kpi.misc.politics	275
alt.binaries.nospam.female.short-hair	274
alt.binaires.erotica	274
alt.binaires.pictures.erotica.butts	273
alt.binaires.pictures.erotica.amatuer.female	273
alt.binaries.pictures.brunettes	265
alt.binaries.pictures.senior-citizens	264
pictures.erotica.lesbians	256
alt.binaries.pictures.erotica.breats	254
alt.binaries.pictures.erotica.young.female	251
alt.binaries.nospam.christinamodel	248

TOTAL: 3406	48190

INND misc events:

Events	Count

CCreader	2

TOTAL: 1	2

Miscellaneous innd statistics [Top 10]:

Event	Server	Number

Bad newsgroups received
	SERVER	1
	TOTAL: 1	1
Including strange strings
	192.168.33.37	27367
	TOTAL: 1	27367

TOTAL: 2		27368

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed

1	ts18-a96.moscow.dial.rol.ru	1	13	711.1 KB	2	0	0	00:25:09

TOTAL: 1		1	13	711.1 KB	2	0	2	00:42:27

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed

1	*.moscow.dial.rol.ru	1	13	711.1 KB	2	0	0	00:25:09
2	*.sovintel.net	15	0	0.0 KB	0	0	0	00:00:05
3	unresolved	1	0	0.0 KB	0	0	0	00:00:01
4	*.tony.pp.ru	70	0	0.0 KB	0	0	0	00:02:26
5	*.rol.ru	5760	0	0.0 KB	0	0	0	00:14:44
6	*.tr155m.lavtech.ru	1	0	0.0 KB	0	0	1	00:00:00

TOTAL: 6		5848	13	711.1 KB	2	0	1	00:42:27

NNRP total resource statistics [Top 20]:

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

ts18-a96.moscow.dial.rol.ru	0.004	0.012	0.000	00:25:09
balancer-b.rol.ru	3.364	3.316	0.000	00:07:27
balancer-a.rol.ru	3.024	3.452	0.000	00:07:16
net1-x-ring.tony.pp.ru	0.080	0.092	0.000	00:02:26
fw-nat.sovintel.net	0.096	0.048	0.000	00:00:05
213.206.40.159	0.060	0.032	0.000	00:00:01
web02.tr155m.lavtech.ru	0.000	0.000	0.000	00:00:00
cornholio.migtel.ru	0.000	0.004	0.000	00:00:00
207.215.c10008-a53.dsl-dynamic.vsi.ru	0.012	0.000	0.000	00:00:00
ppp85-141-249-109.pppoe.mtu-net.ru	0.000	0.000	0.000	00:00:00

TOTAL: 10	6.640	6.956	0.000	00:42:27

Curious NNRP server explorers [Top 20]:

System	Conn

balancer-b.rol.ru	2880
balancer-a.rol.ru	2880
net1-x-ring.tony.pp.ru	70
fw-nat.sovintel.net	15
web02.tr155m.lavtech.ru	1
213.206.40.159	1

TOTAL: 6	5847

NNRP no permission clients:

System	Conn

207.215.c10008-a53.dsl-dynamic.vsi.ru	3
ppp85-141-249-109.pppoe.mtu-net.ru	1
cornholio.migtel.ru	1

TOTAL: 3	5

Newsgroup request counts (by category):

Category		Count	Pct

1	alt	11	84.6%
2	japan	2	15.4%

TOTAL: 2		13	100.0%

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

Newsgroup		Count

1	alt.binaries.pictures.lolita	11
2	japan.binaries.pictures.lolita	2

TOTAL: 2		13