Daily Usenet report

Dec 1 03:00:03 -- Dec 2 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 / 31 lines (16.1%)
Dec 1 06:40:07 andromeda controlchan[31171]: Unknown "cmsg" control by truncky512.bbs@bbs.wretch.cc
Dec 1 09:40:07 andromeda controlchan[31171]: Unknown "cmsg" control by feng63.bbs@bbs.wretch.cc
Dec 1 10:50:10 andromeda controlchan[31171]: Unknown "cmsg" control by eehotdog.bbs@bbs.wretch.cc
Dec 1 11:33:59 andromeda controlchan[31171]: Unknown "cmsg" control by hahoha.bbs@bbs.csie.fju.edu.tw
Dec 1 14:04:28 andromeda controlchan[31171]: Broken headers in article <cancel.384b.m07110111035235@4ax.com.mirrorpost.tw.bbs.campus.nctu>

Log entries by program:

Program name	Lines	%Lines	Size	%Size

inn	2206835	98.2%	195.5 MB	97.5%
innd	19580	0.9%	2.5 MB	1.2%
nnrpd	19530	0.9%	2.0 MB	1.0%
cnfsstat	2304	0.1%	400.4 KB	0.2%
controlchan	38	0.0%	4.3 KB	0.0%

TOTAL: 5	2248287	100.0%	200.4 MB	100.0%

History cache:

Reason	Count	%Count

Do not exist	2164516	97.0%
Negative hits	42512	1.9%
Positive hits	23428	1.0%
Cache misses	1055	0.0%

TOTAL: 4	2231511	100.0%

INND timer:

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

article cancel	00:01:34.680	0.1%	37245	0.000	2.542	674.000
article cleanup	00:00:33.832	0.0%	2154130	0.000	0.016	0.029
article logging	00:02:41.765	0.2%	2168739	0.006	0.075	4.468
article parse	00:20:26.767	1.4%	137754041	0.006	0.009	0.040
article write	07:00:53.621	29.2%	2113095	3.648	11.951	124.714
artlog/artcncl	00:00:01.314	0.0%	36844	0.000	0.036	7.870
artlog/artparse	00:00:00.000	0.0%	46	0.000	0.000	0.000
data move	00:05:08.358	0.4%	146924205	0.002	0.002	0.004
hisgrep/artcncl	00:01:07.380	0.1%	20612	0.000	3.269	1136.000
hishave/artcncl	00:00:04.021	0.0%	37245	0.000	0.108	120.154
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	00:41:54.611	2.9%	2194589	0.001	1.146	11.837
history sync	00:00:01.618	0.0%	289	0.000	5.599	806.000
history write	02:37:54.221	11.0%	2146764	0.035	4.413	39.472
hiswrite/artcncl	00:00:21.484	0.0%	16633	0.000	1.292	404.500
idle	06:12:30.026	25.9%	127574702	0.116	0.175	35.237
nntp read	00:22:45.445	1.6%	136337319	0.007	0.010	0.067
overview write	06:04:13.646	25.3%	2113095	3.221	10.342	65.614
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%	38	0.000	0.026	1.000

TOTAL: 23:59:24.929	23:32:12.790	98.1%	-	-	-	-

nnrpd timer:

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

hisgrep	00:37:20.562	3.1%	36296	0.000	61.730	69.588
idle	17:06:28.506	86.4%	100265	0.000	614.257	200101.000
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:56:12.795	4.7%	497956	0.000	6.773	3361.623
readart	00:36:43.679	3.1%	74976	0.000	29.392	302.667

TOTAL: 19:48:33.489	19:16:45.542	97.3%	-	-	-	-

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

bc_van_usenet@fastmail.ca	0	0	2	0	0	2
control-microsoft@trigofacile.com	0	0	1	0	0	1
news@news2.open-news-network.org	0	0	1	0	0	1
sfnet@hopeatilhi.cs.tut.fi	0	1	0	0	0	1
teko@dinoex.sub.org	0	0	1	0	0	1
wkronert@sunstroke.sdsu.edu	0	0	1	0	0	1

TOTAL	0	1	6	0	0	7

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed

1	192.168.33.37	316	2142861	2106540	20	36301	98%	479:15:31

TOTAL: 1		316	2142861	2106540	20	36301	98%	479:15:31

Incoming Volume (INN):

Server		AcceptVol	DupVol	TotalVol	%Acc	Vol/Art	Elapsed

1	192.168.33.37	382.7 GB	12.1 MB	382.7 GB	99%	187.3 KB	479:15:31

TOTAL: 1		382.7 GB	12.1 MB	382.7 GB	99%	187.3 KB	479:15:31

Incoming articles:

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

Dec 1 03:00:03 - 03:59:59	82371	3.9%	22.90	15.8 GB	4.1%	4592.75
Dec 1 04:00:00 - 04:59:59	84419	4.0%	23.45	15.8 GB	4.1%	4611.96
Dec 1 05:00:00 - 05:59:59	86189	4.1%	23.94	16.4 GB	4.3%	4773.14
Dec 1 06:00:00 - 06:59:59	77138	3.6%	21.43	14.8 GB	3.9%	4310.69
Dec 1 07:00:00 - 07:59:59	81625	3.9%	22.67	15.6 GB	4.1%	4556.29
Dec 1 08:00:00 - 08:59:59	80895	3.8%	22.47	15.5 GB	4.1%	4522.78
Dec 1 09:00:00 - 09:59:59	78829	3.7%	21.90	15.2 GB	4.0%	4438.95
Dec 1 10:00:00 - 10:59:59	84006	4.0%	23.34	16.5 GB	4.3%	4804.96
Dec 1 11:00:00 - 11:59:59	82731	3.9%	22.98	16.2 GB	4.2%	4707.60
Dec 1 12:00:00 - 12:59:59	94003	4.4%	26.11	18.0 GB	4.7%	5250.98
Dec 1 13:00:00 - 13:59:59	90431	4.3%	25.12	16.6 GB	4.3%	4821.26
Dec 1 14:00:00 - 14:59:59	88410	4.2%	24.56	15.3 GB	4.0%	4468.27
Dec 1 15:00:00 - 15:59:59	96333	4.6%	26.76	16.3 GB	4.2%	4741.84
Dec 1 16:00:00 - 16:59:59	93826	4.4%	26.06	16.5 GB	4.3%	4793.19
Dec 1 17:00:00 - 17:59:59	96898	4.6%	26.92	17.2 GB	4.5%	5001.32
Dec 1 18:00:00 - 18:59:59	97729	4.6%	27.15	17.1 GB	4.5%	4967.76
Dec 1 19:00:00 - 19:59:59	84176	4.0%	23.38	14.9 GB	3.9%	4343.87
Dec 1 20:00:00 - 20:59:59	89812	4.2%	24.95	15.9 GB	4.1%	4618.25
Dec 1 21:00:00 - 21:59:59	90394	4.3%	25.11	16.3 GB	4.3%	4751.38
Dec 1 22:00:00 - 22:59:59	91307	4.3%	25.36	16.2 GB	4.2%	4717.94
Dec 1 23:00:00 - 23:59:59	86785	4.1%	24.11	16.5 GB	4.3%	4799.50
Dec 2 00:00:00 - 00:59:59	85885	4.1%	23.86	14.8 GB	3.9%	4304.51
Dec 2 01:00:00 - 01:59:59	96204	4.6%	26.72	14.9 GB	3.9%	4342.61
Dec 2 02:00:00 - 02:59:59	93630	4.4%	26.01	15.0 GB	3.9%	4357.02
Dec 2 03:00:00 - 03:00:02	84	0.0%	42.00	14.9 MB	0.0%	7603.53

TOTAL: 23:59:59	2114110	100.0%	24.47	383.1 GB	100.0%	4650.02

CNFS buffer status:

Buffer	Class	Size	Used	%Used	Cycles	KB/sec	Days

01	BIN	137.8 GB	101.5 GB	73.7%	99	772.43	2.17
02	BIN	137.8 GB	119.4 GB	86.7%	99	780.73	2.14
03	SMALL	13.0 GB	8.2 GB	62.9%	6	6.78	23.35
04	BIN	80.1 GB	64.5 GB	80.5%	69	388.87	2.50
05	BIN	80.1 GB	36.7 GB	45.8%	86	389.70	2.49
06	SMALL	13.0 GB	7.9 GB	61.0%	6	6.76	23.40
07	BIN	80.1 GB	59.5 GB	74.3%	69	388.09	2.50
08	BIN	80.1 GB	31.9 GB	39.9%	86	389.10	2.50
09	SMALL	13.0 GB	8.0 GB	61.7%	6	6.73	23.50
10	BIN	80.1 GB	56.3 GB	70.3%	69	387.79	2.51
11	BIN	80.1 GB	42.9 GB	53.6%	86	389.88	2.49
12	BIN	13.0 GB	926.2 MB	6.9%	67	388.27	0.41
13	BIN	80.1 GB	76.1 GB	95.1%	10	389.53	2.50
14	SMALL	80.1 GB	14.3 GB	17.9%	0	6.78	143.47

TOTAL: 14	-	968.5 GB	628.2 GB	64.9%	758	335.32	-

Sites sending bad articles:

Server		Total	Group	Dist	Duplic	Unapp	TooOld	Site	Line	Other

1	192.168.33.37	55707	33679	0	3868	0	0	0	0	18160
2	?	46	0	0	0	0	0	0	0	46

TOTAL: 2		55753	33679	0	3868	0	0	0	0	18206

Unwanted newsgroups [Top 20]:

Newsgroup	Count

alt.binaries.pictures.amateur.butts	1631
alt.binaries.game	1306
microsoft.public.test	1154
alt.binaries.	577
alt.binaries.pictures.erotica.asian.female	362
alt.binaires.pictures.erotica.male	349
alt.binaries.jerry	336
alt.binaries.erotica.freckles	323
pictures.erotica.lesbians	308
alt.binaries.pictures.erotica.group.sex	297
alt.binaries.pictures.erotica.teen.male.masturbation	292
alt.binaries.pictures.erotica.exhibionism	273
alt.binaries.b4e.erotica	249
alt.binaries.pictures.erotica.breasts.sm	225
alt.pictures.erotica	208
alt.binaries.pictures.eroctica.butts	204
alt.sci.physics	200
alt.binaries.pictures.erotica.exhibitionismw	199
talk.politics	187
alt.binaries.pictures.erotica.female.ejaculation	177

TOTAL: 1837	33679

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

TOTAL: 2		14617

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed

1	keyhole.sovam.com	4	36296	4.5 GB	12	0	0	15:01:06
2	adsl-195.218.206.168.ranetka.ru	13	308	22.9 MB	34	0	0	03:31:30
3	ts16-a50.moscow.dial.rol.ru	1	30	2.4 MB	1	0	0	00:11:38
4	ts30-b162.moscow.dial.rol.ru	5	12	14.2 KB	2	0	0	00:00:16
5	ts30-b142.moscow.dial.rol.ru	5	1	1.2 KB	1	0	0	00:00:05
6	ts3-b156.nnovgorod.dial.rol.ru	2	1	3.5 KB	2	0	0	00:10:57

TOTAL: 6		30	36648	4.6 GB	52	0	2	19:47:54

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Post	Rej	Elapsed

1	*.sovam.com	4	36296	4.5 GB	12	0	0	15:01:06
2	*.218.206.168.ranetka.ru	13	308	22.9 MB	34	0	0	03:31:30
3	*.moscow.dial.rol.ru	18	43	2.4 MB	4	0	0	00:18:16
4	*.nnovgorod.dial.rol.ru	2	1	3.5 KB	2	0	0	00:10:57
5	*.krasnoyarsk.dial.rol.ru	3	0	0.0 KB	0	0	0	00:02:29
6	*.sovintel.net	9	0	0.0 KB	0	0	0	00:00:09
7	*.sarov.dial.rol.ru	1	0	0.0 KB	0	0	0	00:02:29
8	unresolved	78	0	0.0 KB	0	0	0	00:04:03
9	*.spb.dial.rol.ru	3	0	0.0 KB	0	0	0	00:00:03
10	*.tony.pp.ru	67	0	0.0 KB	0	0	0	00:15:39
11	*.lek.ru	1	0	0.0 KB	0	0	0	00:00:12
12	*.pcs-net.net	1	0	0.0 KB	0	0	0	00:00:01
13	*.rol.ru	5783	0	0.0 KB	0	0	0	00:18:54
14	*.nn.ru	27	0	0.0 KB	0	0	0	00:00:10
15	*.nsk.dial.rol.ru	14	0	0.0 KB	0	0	0	00:00:14
16	*.tr155m.lavtech.ru	1	0	0.0 KB	0	0	1	00:00:03

TOTAL: 16		6025	36648	4.6 GB	52	0	1	19:47:34

NNRP total resource statistics [Top 20]:

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

keyhole.sovam.com	17.416	167.151	0.000	15:01:06
adsl-195.218.206.168.ranetka.ru	0.076	0.276	0.000	03:31:30
net1-x-ring.tony.pp.ru	0.412	1.076	0.000	00:15:39
ts16-a50.moscow.dial.rol.ru	0.004	0.008	0.000	00:11:38
ts3-b156.nnovgorod.dial.rol.ru	0.008	0.004	0.000	00:10:57
balancer-a.rol.ru	4.048	3.672	0.000	00:09:38
balancer-b.rol.ru	3.656	3.912	0.000	00:09:15
ts18-a76.moscow.dial.rol.ru	0.068	0.108	0.000	00:05:52
212.46.203.12	0.012	0.016	0.000	00:02:39
ts2-a95.sarov.dial.rol.ru	0.000	0.004	0.000	00:02:29
ts1-b159.krasnoyarsk.dial.rol.ru	0.000	0.012	0.000	00:02:29
194.154.66.148	0.116	0.120	0.000	00:01:18
?	0.008	0.020	0.000	00:01:11
cornholio.migtel.ru	0.152	0.212	0.000	00:00:20
ts30-b162.moscow.dial.rol.ru	0.012	0.004	0.000	00:00:16
ts2-a36.nsk.dial.rol.ru	0.040	0.036	0.000	00:00:14
news.lek.ru	0.152	0.156	0.000	00:00:12
ts30-a235.moscow.dial.rol.ru	0.012	0.012	0.000	00:00:11
ts16-a8.moscow.dial.rol.ru	0.000	0.000	0.000	00:00:10
gray.nn.ru	0.052	0.040	0.000	00:00:10

TOTAL: 32	26.368	176.987	0.000	19:47:54

Curious NNRP server explorers [Top 20]:

System	Conn

balancer-b.rol.ru	2903
balancer-a.rol.ru	2880
net1-x-ring.tony.pp.ru	67
194.154.66.148	67
gray.nn.ru	27
ts2-a36.nsk.dial.rol.ru	14
fw-nat.sovintel.net	9
195.98.59.67	7
ts30-a235.moscow.dial.rol.ru	5
ts1-b159.krasnoyarsk.dial.rol.ru	3
ts5-b204.spb.dial.rol.ru	3
212.46.203.127	2
212.46.203.12	2
news.pcs-net.net	1
news.lek.ru	1
ts2-a95.sarov.dial.rol.ru	1
cappa.tr155m.lavtech.ru	1
ts16-a8.moscow.dial.rol.ru	1
ts18-a76.moscow.dial.rol.ru	1

TOTAL: 19	5995

NNRP no permission clients:

System	Conn

cornholio.migtel.ru	116
ppp85-141-128-61.pppoe.mtu-net.ru	2
168.126.248.238	1
drebot.users.odessa.comstar.net.ua	1
195.28.36.242	1
77.94.201.111	1

TOTAL: 6	122

NNRP gethostbyaddr failures [Top 20]:

System	Conn

? (can't getpeername)	21

TOTAL: 1	21

NNRP client timeouts [Top 20]:

System	Conn	Peer

adsl-195.218.206.168.ranetka.ru	6	0
ts3-b156.nnovgorod.dial.rol.ru	1	0

TOTAL: 2	7	0

Newsgroup request counts (by category):

Category		Count	Pct

1	alt	36634	100.0%
2	hr	13	0.0%
3	lada	1	0.0%

TOTAL: 3		36648	100.0%

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

Newsgroup		Count

1	alt.binaries.pictures.erotica.vintage	30338
2	alt.binaries.pictures.bras	4258
3	alt.binaries.pictures.artpics	1700
4	alt.binaries.pictures.erotica.age.13-17	48
5	alt.binaries.erotica.amateur	46
6	alt.binaries.erotica.voyeurism	45
7	alt.binaries.pictures.erotic.pre-teen	41
8	alt.binaries.pictures.eroctica.teen.fuck	38
9	alt.sex.binaries	30
10	alt.binaries.erotica.cheerleaders	25
11	alt.binaries.pictures.erotica.alt.sex.pictures	23
12	alt.binaries.erotica.amateur.facial	15
13	alt.binaries.bisexuals	13
14	hr.rec.humor	9
15	alt.binaries.erotica.schoolgirls	4
16	hr.talk.razno	4
17	alt.binaries.pictures.erotica.amateur.lolita	3
18	alt.binaries.multimedia.erotica.cum-swapping	3
19	alt.binaries.erotica.pornstars.90s	2
20	lada.music	1
21	alt.binaries.pictures.erotic.amateur	1
22	alt.binaries.dvd.erotica.scenes	1

TOTAL: 22		36648