Daily Usenet report: Jun 12 04:15:03

Unknown entries from news log file:

First 4 / 4 lines (100.0%)

Jun 12 08:53:43 newsfeed nnrpd[10575]: SERVER perl filter not defined
Jun 12 13:33:31 newsfeed nnrpd[20172]: SERVER perl filter not defined
Jun 12 14:43:28 newsfeed nnrpd[22516]: SERVER perl filter not defined
Jun 12 15:34:05 newsfeed nnrpd[24195]: SERVER perl filter not defined

Log entries by program:

Program name	Lines	%Lines	Size	%Size
inn	1278239	97.7%	145.1 MB	97.1%
innd	12981	1.0%	2.2 MB	1.5%
nnrpd	9931	0.8%	1.1 MB	0.7%
innfeed	7028	0.5%	1.0 MB	0.7%
TOTAL: 4	1308179	100.0%	149.4 MB	100.0%

History cache:

Reason	Count	%Count
Do not exist	1272003	93.8%
Positive hits	43430	3.2%
Negative hits	40423	3.0%
Cache misses	273	0.0%
TOTAL: 4	1356129	100.0%

INND timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article cancel	00:00:11.041	0.0%	616	0.000	17.924	621.000
article cleanup	00:00:16.693	0.0%	1276736	0.000	0.013	0.041
article logging	00:00:37.616	0.0%	1276977	0.010	0.029	0.530
article parse	00:40:15.329	2.8%	208470579	0.006	0.012	0.079
article write	00:13:29.469	0.9%	1270834	0.206	0.637	2.079
artlog/artcncl	00:00:00.013	0.0%	544	0.000	0.024	1.000
artlog/artparse	00:00:00.000	0.0%	3	0.000	0.000	0.000
data move	00:03:09.654	0.2%	217633165	0.000	0.001	0.110
hisgrep/artcncl	00:00:02.361	0.0%	483	0.000	4.888	44.000
hishave/artcncl	00:00:01.527	0.0%	616	0.000	2.479	54.000
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	01:11:38.309	5.0%	1356740	0.011	3.168	7.305
history sync	00:00:00.013	0.0%	293	0.000	0.044	1.000
history write	02:46:02.215	11.5%	1272990	0.109	7.826	19.131
hiswrite/artcncl	00:00:01.179	0.0%	133	0.000	8.865	115.500
idle	14:51:44.949	61.9%	178393999	0.108	0.300	2.307
nntp read	00:46:31.059	3.2%	207617174	0.008	0.013	0.056
overview write	00:00:06.914	0.0%	1270834	0.000	0.005	0.044
perl filter	02:36:29.340	10.9%	1272987	4.434	7.376	14.066
python filter	00:00:00.000	0.0%	0	0.000	0.000	0.000
site send	00:02:20.751	0.2%	2594470	0.031	0.054	0.114
TOTAL: 23:59:33.737	23:12:58.432	96.8%	-	-	-	-

INNfeed timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article new	00:00:00.165	0.0%	52811	0.000	0.003	0.100
article prepare	00:00:00.012	0.0%	63140	0.000	0.000	0.050
article read	00:00:01.444	0.0%	15122	0.000	0.095	16.000
backlog stats	00:00:00.211	0.0%	368742	0.000	0.001	0.013
callbacks	00:00:00.000	0.0%	2	0.000	0.000	0.000
data read	00:00:02.033	0.0%	217252	0.000	0.009	1.000
data write	00:00:05.478	0.0%	173258	0.000	0.032	60.000
idle	23:59:33.319	100.0%	368742	0.000	234.238	10855.000
status file	00:00:00.239	0.0%	218	0.000	1.096	10.000
TOTAL: 23:59:49.861	23:59:42.901	100.0%	-	-	-	-

nnrpd timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
idle	04:12:03.851	99.8%	6996	0.000	2161.785	501154.000
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:00:00.306	0.0%	16491	0.000	0.019	2.333
readart	00:00:00.508	0.0%	409	0.000	1.242	12.000
TOTAL: 04:12:40.265	04:12:04.665	99.8%	-	-	-	-

Control commands to INND:

Command	Number
L	1
flush	24
flushlogs	2
go	2
logmode	2
mode	149
name	2
pause	2
paused	2
reload	2
reserve	2
TOTAL: 11	190

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed
1	newsfeed.pionier.net.pl	627	1266159	1261717	663	3779	99%	201:56:01
2	news.task.gda.pl	13	29667	4956	23288	1423	16%	45:42:35
3	news.nask.pl	2	19902	4802	14472	628	24%	23:56:22
4	localhost	5	4	4	0	0	100%	00:00:00
5	news.icm.edu.pl	37	260	1	227	32	0%	17:00:53
TOTAL: 5		684	1315992	1271480	38650	5862	96%	288:35:51

Incoming Volume (INN):

Server		AcceptVol	DupVol	RejVol	TotalVol	%Acc	Vol/Art
1	newsfeed.pionier.net.pl	448.2 GB	13.1 MB	23.4 MB	448.2 GB	99%	371.4 KB
2	news.nask.pl	17.6 MB	1.6 MB	1.7 MB	20.9 MB	84%	3.9 KB
3	news.task.gda.pl	11.6 MB	33.9 KB	4.2 MB	15.9 MB	73%	2.5 KB
4	news.icm.edu.pl	8.6 KB	0.0 KB	379.5 KB	388.0 KB	2%	11.8 KB
5	localhost	7.2 KB	0.0 KB	0.0 KB	7.2 KB	100%	1.8 KB
TOTAL: 5		448.2 GB	14.6 MB	29.7 MB	448.2 GB	99%	368.0 KB

Incoming articles:

Date	Articles	%Arts	Art/sec	Size	%Size	KB/sec
Jun 12 04:15:03 - 04:59:59	70251	5.5%	26.05	24.0 GB	5.4%	9348.78
Jun 12 05:00:00 - 05:59:59	95354	7.5%	26.49	32.1 GB	7.1%	9336.21
Jun 12 06:00:00 - 06:59:59	88624	7.0%	24.62	29.9 GB	6.7%	8708.22
Jun 12 07:00:00 - 07:59:59	48626	3.8%	13.51	19.2 GB	4.3%	5596.99
Jun 12 08:00:00 - 08:59:59	43706	3.4%	12.14	16.1 GB	3.6%	4682.39
Jun 12 09:00:00 - 09:59:59	40160	3.2%	11.16	14.8 GB	3.3%	4312.88
Jun 12 10:00:00 - 10:59:59	39807	3.1%	11.06	14.3 GB	3.2%	4151.35
Jun 12 11:00:00 - 11:59:59	43469	3.4%	12.07	16.5 GB	3.7%	4794.38
Jun 12 12:00:00 - 12:59:59	35830	2.8%	9.95	14.0 GB	3.1%	4088.75
Jun 12 13:00:00 - 13:59:59	39077	3.1%	10.85	14.8 GB	3.3%	4323.92
Jun 12 14:00:00 - 14:59:59	41067	3.2%	11.41	15.1 GB	3.4%	4404.88
Jun 12 15:00:00 - 15:59:59	45104	3.5%	12.53	17.0 GB	3.8%	4939.10
Jun 12 16:00:00 - 16:59:59	44802	3.5%	12.45	16.1 GB	3.6%	4701.68
Jun 12 17:00:00 - 17:59:59	45455	3.6%	12.63	16.1 GB	3.6%	4698.57
Jun 12 18:00:00 - 18:59:59	44005	3.5%	12.22	16.7 GB	3.7%	4868.14
Jun 12 19:00:00 - 19:59:59	48040	3.8%	13.34	17.7 GB	3.9%	5159.48
Jun 12 20:00:00 - 20:59:59	46867	3.7%	13.02	16.9 GB	3.8%	4927.99
Jun 12 21:00:00 - 21:59:59	33775	2.7%	9.38	10.5 GB	2.3%	3056.76
Jun 12 22:00:00 - 22:59:59	32130	2.5%	8.93	9.6 GB	2.1%	2802.25
Jun 12 23:00:00 - 23:59:59	30931	2.4%	8.59	9.5 GB	2.1%	2779.47
Jun 13 00:00:00 - 00:59:59	77451	6.1%	21.51	25.7 GB	5.7%	7479.13
Jun 13 01:00:00 - 01:59:59	69698	5.5%	19.36	23.9 GB	5.3%	6966.30
Jun 13 02:00:00 - 02:59:59	67182	5.3%	18.66	23.6 GB	5.3%	6878.88
Jun 13 03:00:00 - 03:59:59	78928	6.2%	21.92	27.2 GB	6.1%	7913.23
Jun 13 04:00:00 - 04:15:03	21213	1.7%	23.49	7.4 GB	1.6%	8551.31
TOTAL: 24:00:00	1271552	100.0%	14.72	448.8 GB	100.0%	5446.66

Sites sending bad articles:

Server		Total	Group	Duplic	Unapp	Other
1	newsfeed.pionier.net.pl	4001	293	3249	0	459
2	news.task.gda.pl	1458	1110	21	0	327
3	news.nask.pl	639	6	478	1	154
4	news.icm.edu.pl	45	0	0	0	45
TOTAL: 4		6143	1409	3748	1	985

Unwanted newsgroups [Top 20]:

Newsgroup	Count
mailing.gcc.gcc-cvs	113
it.tlc.cellulari.android	95
mailing.freebsd.svn-ports-all	92
mailing.freebsd.svn-ports-head	92
mailing.freebsd.ports-bugs	62
uk.railway	60
mailing.freebsd.svn-src-all	51
fa.freebsd.cvs-all	49
mailing.freebsd.current	44
mailing.database.pgsql-general	42
nl.comp.os.linux.techniek	40
mailing.openssl.dev	38
mozilla.dev.tree-management	38
fr.usenet.abus.nocem	36
mailing.unix.samba	33
mailing.freebsd.tinderbox	33
mailing.freebsd.ports	31
it.comp.os.win.windows8	29
mailing.freebsd.svn-src-head	26
mailing.unix.samba-technical	24
TOTAL: 80	1409

Supposedly-moderated groups with unmoderated postings [Top 20]:

Groups	Count
bit.listserv.catholic	1
TOTAL: 1	1

INND Perl filter [Top 20]:

Reason	Count
EMP (fsl)	465
Binary in non-binary group	173
EMP (md5)	47
Attached HTML file	43
EMP (phl)	7
HTML post	5
Scoring filter (9)	1
TOTAL: 7	741

Outgoing Feeds (innfeed) by Articles:

Server		Offered	Taken	Refused	Reject	Miss	Spool	%Took	Elapsed
1	icm	56082	9226	24448	3578	24	10	16%	23:59:58
2	panorama	60238	2358	50058	358	0	0	3%	24:00:42
3	nask	26335	137	15696	2	0	0	0%	24:03:21
4	poznan	12230	53	9742	11	0	0	0%	24:06:05
5	task	2088	31	1069	7	0	0	1%	22:27:40
6	okapi	0	0	0	0	0	2673	0%	24:00:02
TOTAL: 6		156973	11805	101013	3956	24	2683	7%	142:37:48

Outgoing Feeds (innfeed) by Volume:

Server		AcceptVol	RejectVol	TotalVol	Volume/sec	Vol/Art	Elapsed
1	icm	104.3 MB	318.5 MB	422.8 MB	5.0 KB/s	33.8 KB	23:59:58
2	panorama	9.7 MB	1.4 MB	11.1 MB	0.1 KB/s	4.2 KB	24:00:42
3	nask	472.0 KB	702.2 KB	1.1 MB	0.0 KB/s	8.4 KB	24:03:21
4	poznan	141.1 KB	43.1 KB	184.3 KB	0.0 KB/s	2.9 KB	24:06:05
5	task	64.5 KB	12.6 KB	77.1 KB	0.0 KB/s	2.0 KB	22:27:40
6	okapi	0.0 KB	0.0 KB	0.0 KB	0.0 KB/s	0	24:00:02
TOTAL: 6		114.7 MB	320.7 MB	435.4 MB	0.9 KB/s	28.3 KB	142:37:48

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Post	Elapsed
1	pc-skrzep2.cm.p.lodz.pl	288	336	632.6 KB	288	0	00:00:08
2	lze200.lze.lodz.pl	6	41	74.9 KB	7	0	00:11:24
3	web.man.lodz.pl	288	28	29.4 KB	13	0	00:00:25
4	194.33.77.50	2	4	7.2 KB	1	0	00:01:31
5	isvcs01.man.lodz.pl	4	0	0.0 KB	0	4	00:00:00
TOTAL: 5		588	409	744.2 KB	309	4	04:12:38

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Post	Elapsed
1	*.cm.p.lodz.pl	288	336	632.6 KB	288	0	00:00:08
2	*.lze.lodz.pl	6	41	74.9 KB	7	0	00:11:24
3	*.man.lodz.pl	676	28	29.4 KB	13	4	00:00:35
4	unresolved	2	4	7.2 KB	1	0	00:01:31
5	*.pa.nsw.optusnet.com.au	661	0	0.0 KB	0	0	00:18:58
6	*.wroclaw.mm.pl	20	0	0.0 KB	0	0	03:14:36
7	*.105.135.22.tvsat364.lodz.pl	4	0	0.0 KB	0	0	00:25:18
8	*.toya.net.pl	75	0	0.0 KB	0	0	00:00:06
TOTAL: 8		1732	409	744.2 KB	309	4	04:12:38

NNRP total resource statistics [Top 20]:

System	User(ms)	System(ms)	Elapsed
host-89-231-50-15.wroclaw.mm.pl	0.024	0.192	03:14:36
ip-176.105.135.22.tvsat364.lodz.pl	0.008	0.024	00:25:18
pa49-181-247-5.pa.nsw.optusnet.com.au	0.976	4.700	00:18:58
lze200.lze.lodz.pl	0.012	0.092	00:11:24
194.33.77.50	0.004	0.024	00:01:31
web.man.lodz.pl	0.468	3.060	00:00:25
pc-skrzep2.cm.p.lodz.pl	0.504	2.508	00:00:08
mon.man.lodz.pl	0.504	2.288	00:00:07
staticline41435.toya.net.pl	0.108	0.556	00:00:06
david.man.lodz.pl	0.168	0.820	00:00:01
isvcs01.man.lodz.pl	0.020	0.056	00:00:00
?	0.000	0.016	00:00:00
TOTAL: 12	2.796	14.336	04:12:38

Curious NNRP server explorers [Top 20]:

System	Conn
pa49-181-247-5.pa.nsw.optusnet.com.au	661
mon.man.lodz.pl	288
david.man.lodz.pl	96
staticline41435.toya.net.pl	75
host-89-231-50-15.wroclaw.mm.pl	20
ip-176.105.135.22.tvsat364.lodz.pl	4
TOTAL: 6	1144

NNRP gethostbyaddr failures [Top 20]:

System	Conn
? (can't getpeername)	1
TOTAL: 1	1

NNRP client timeouts [Top 20]:

System	Conn	Peer
lze200.lze.lodz.pl	1	1
TOTAL: 1	1	2

Newsgroup request counts (by category):

Category		Count	Pct
1	lodman	340	83.1%
2	pl	69	16.9%
TOTAL: 2		409	100.0%

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

Newsgroup		Count
1	lodman.info	340
2	pl.comp.os.ms-windows.winnt	26
3	pl.misc.telefonia.gsm	21
4	pl.comp.pecet	14
5	pl.comp.os.linux	6
6	pl.rec.dom	2
TOTAL: 6		409

Daily Usenet report

Jun 12 04:15:03 -- Jun 13 04:15:03