Daily Usenet report: Aug 19 04:15:02

Unknown entries from news log file:

First 2 / 2 lines (100.0%)

Aug 19 12:16:40 newsfeed nnrpd[19152]: SERVER perl filter not defined
Aug 20 04:15:01 newsfeed nnrpd[18621]: web.man.lodz.pl rejected Flushing log and syslog files

Log entries by program:

Program name	Lines	%Lines	Size	%Size
inn	1273774	97.3%	147.1 MB	96.7%
innd	21937	1.7%	3.3 MB	2.2%
nnrpd	7235	0.6%	749.6 KB	0.5%
innfeed	6778	0.5%	1015.5 KB	0.7%
TOTAL: 4	1309724	100.0%	152.1 MB	100.0%

History cache:

Reason	Count	%Count
Do not exist	1269749	93.6%
Negative hits	68586	5.1%
Positive hits	18649	1.4%
Cache misses	137	0.0%
TOTAL: 4	1357121	100.0%

INND timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article cancel	00:00:06.215	0.0%	403	0.000	15.422	339.000
article cleanup	00:00:19.613	0.0%	1273539	0.000	0.015	0.047
article logging	00:00:35.882	0.0%	1273642	0.003	0.028	0.188
article parse	00:43:55.583	3.0%	124567913	0.011	0.021	0.043
article write	00:11:00.203	0.8%	1260000	0.196	0.524	2.877
artlog/artcncl	00:00:00.005	0.0%	392	0.000	0.013	1.000
artlog/artparse	00:00:00.000	0.0%	0	0.000	0.000	0.000
data move	00:01:53.856	0.1%	132535802	0.000	0.001	0.002
hisgrep/artcncl	00:00:00.842	0.0%	311	0.000	2.707	189.000
hishave/artcncl	00:00:00.710	0.0%	403	0.000	1.762	215.000
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	01:42:33.777	7.1%	1357607	0.008	4.533	18.532
history sync	00:00:00.019	0.0%	293	0.000	0.065	2.000
history write	02:34:59.937	10.8%	1270331	0.059	7.321	28.654
hiswrite/artcncl	00:00:00.431	0.0%	92	0.000	4.685	17.750
idle	14:43:03.127	61.3%	91106533	0.220	0.582	1.991
nntp read	00:47:32.599	3.3%	123550433	0.013	0.023	0.035
overview write	00:00:07.705	0.0%	1260000	0.000	0.006	0.019
perl filter	02:36:16.676	10.8%	1270331	4.914	7.381	10.258
python filter	00:00:00.000	0.0%	0	0.000	0.000	0.000
site send	00:02:48.639	0.2%	2551876	0.012	0.066	0.097
TOTAL: 24:00:21.767	23:25:15.819	97.6%	-	-	-	-

INNfeed timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article new	00:00:00.118	0.0%	31877	0.000	0.004	0.125
article prepare	00:00:00.002	0.0%	20934	0.000	0.000	0.125
article read	00:00:00.461	0.0%	4942	0.000	0.093	8.500
backlog stats	00:00:00.140	0.0%	247202	0.000	0.001	0.016
callbacks	00:00:00.000	0.0%	0	0.000	0.000	0.000
data read	00:00:01.651	0.0%	142382	0.000	0.012	1.000
data write	00:00:05.185	0.0%	120347	0.000	0.043	6.000
idle	23:59:08.893	100.0%	247202	0.000	349.305	23215.000
status file	00:00:00.121	0.0%	174	0.000	0.695	12.000
TOTAL: 23:59:22.042	23:59:16.571	100.0%	-	-	-	-

nnrpd timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
idle	00:14:42.534	97.8%	4284	0.000	206.007	30602.636
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:00:00.261	0.0%	10365	0.000	0.025	1.889
readart	00:00:00.556	0.1%	349	0.000	1.593	123.000
TOTAL: 00:15:02.598	00:14:43.351	97.9%	-	-	-	-

Control commands to INND:

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

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed
1	newsfeed.pionier.net.pl	535	1269027	1255224	1091	12712	98%	256:43:33
2	news.nask.pl	3	19004	4304	13951	749	22%	23:59:11
3	news.icm.edu.pl	41	298	7	229	62	2%	18:48:42
4	localhost	2	1	1	0	0	100%	00:00:00
TOTAL: 4		581	1288330	1259536	15271	13523	97%	299:31:26

Incoming Volume (INN):

Server		AcceptVol	DupVol	RejVol	TotalVol	%Acc	Vol/Art
1	newsfeed.pionier.net.pl	382.2 GB	150.4 MB	1.4 GB	383.8 GB	99%	317.4 KB
2	news.nask.pl	35.3 MB	1.9 MB	2.1 MB	39.3 MB	89%	8.0 KB
3	news.icm.edu.pl	105.7 KB	0.0 KB	3.4 MB	3.5 MB	2%	51.7 KB
4	localhost	1.5 KB	0.0 KB	0.0 KB	1.5 KB	100%	1.5 KB
TOTAL: 4		382.3 GB	152.4 MB	1.4 GB	383.8 GB	99%	316.1 KB

Incoming articles:

Date	Articles	%Arts	Art/sec	Size	%Size	KB/sec
Aug 19 04:15:02 - 04:59:59	27138	2.2%	10.06	10.5 GB	2.8%	4094.22
Aug 19 05:00:00 - 05:59:59	33570	2.7%	9.32	13.4 GB	3.5%	3892.56
Aug 19 06:00:00 - 06:59:59	28126	2.2%	7.81	10.9 GB	2.8%	3164.79
Aug 19 07:00:00 - 07:59:59	31577	2.5%	8.77	12.4 GB	3.2%	3614.25
Aug 19 08:00:00 - 08:59:59	30270	2.4%	8.41	9.4 GB	2.5%	2734.42
Aug 19 09:00:00 - 09:59:59	37706	3.0%	10.47	13.8 GB	3.6%	4009.05
Aug 19 10:00:00 - 10:59:59	25628	2.0%	7.12	8.6 GB	2.3%	2512.70
Aug 19 11:00:00 - 11:59:59	50424	4.0%	14.01	15.1 GB	4.0%	4403.85
Aug 19 12:00:00 - 12:59:59	70996	5.6%	19.72	17.9 GB	4.7%	5199.59
Aug 19 13:00:00 - 13:59:59	59554	4.7%	16.54	15.9 GB	4.2%	4636.20
Aug 19 14:00:00 - 14:59:59	69498	5.5%	19.30	16.3 GB	4.3%	4734.35
Aug 19 15:00:00 - 15:59:59	39454	3.1%	10.96	13.7 GB	3.6%	3998.48
Aug 19 16:00:00 - 16:59:59	38742	3.1%	10.76	13.9 GB	3.6%	4037.68
Aug 19 17:00:00 - 17:59:59	34284	2.7%	9.52	12.7 GB	3.3%	3696.65
Aug 19 18:00:00 - 18:59:59	38062	3.0%	10.57	13.7 GB	3.6%	3993.11
Aug 19 19:00:00 - 19:59:59	37511	3.0%	10.42	13.8 GB	3.6%	4024.81
Aug 19 20:00:00 - 20:59:59	36858	2.9%	10.24	13.1 GB	3.4%	3801.32
Aug 19 21:00:00 - 21:59:59	48133	3.8%	13.37	14.4 GB	3.8%	4194.87
Aug 19 22:00:00 - 22:59:59	59340	4.7%	16.48	15.1 GB	4.0%	4397.40
Aug 19 23:00:00 - 23:59:59	57062	4.5%	15.85	14.2 GB	3.7%	4135.53
Aug 20 00:00:00 - 00:59:59	87904	7.0%	24.42	23.6 GB	6.2%	6885.71
Aug 20 01:00:00 - 01:59:59	106060	8.4%	29.46	29.4 GB	7.7%	8559.15
Aug 20 02:00:00 - 02:59:59	100859	8.0%	28.02	29.4 GB	7.7%	8548.86
Aug 20 03:00:00 - 03:59:59	89566	7.1%	24.88	24.7 GB	6.5%	7200.31
Aug 20 04:00:00 - 04:15:01	21418	1.7%	23.77	6.5 GB	1.7%	7512.27
TOTAL: 23:59:59	1259740	100.0%	14.58	382.2 GB	100.0%	4638.56

Sites sending bad articles:

Server		Total	Group	Duplic	Unapp	Other
1	newsfeed.pionier.net.pl	12809	217	2515	0	10077
2	news.nask.pl	771	13	693	1	64
3	news.icm.edu.pl	62	0	0	0	62
TOTAL: 3		13642	230	3208	1	10203

Unwanted newsgroups [Top 20]:

Newsgroup	Count
uk.railway	97
it.tlc.cellulari.android	36
comp.mobile.android	16
comp.mobile.ipad	11
it.comp.os.win.windows7	11
alt.sex.telephones	9
de.comp.office-pakete.ms-office.excel	8
it.comp.os.linux.ubuntu	8
nl.comp.os.linux.techniek	8
uk.rec.cycling.moderated	7
hr.alt.cellular.gsm.android	4
de.comp.lang.vbclassic	4
hr.rec.glazba.hifi	4
sci.physics.acoustics	2
comp.sys.raspberry-pi	2
hr.ponuda.hardver.komponente	1
hr.ponuda.hardver.konfiguracije	1
it.comp.os.win.windows8	1
TOTAL: 18	230

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

Groups	Count
pl.sci.historia	1
TOTAL: 1	1

INND Perl filter [Top 20]:

Reason	Count
Binary in non-binary group	9974
EMP (md5)	67
EMP (fsl)	54
Scoring filter (8)	3
HTML post	2
TOTAL: 5	10100

Miscellaneous innd statistics [Top 10]:

Event	Server	Number
Blocked server feeds
	overview!	1
	TOTAL: 1	1
TOTAL: 1		1

Outgoing Feeds (innfeed) by Articles:

Server		Offered	Taken	Refused	Reject	Miss	Spool	%Took	Elapsed
1	panorama	32814	1441	30079	292	0	0	4%	23:57:50
2	nask	26406	820	16183	31	0	0	3%	24:01:16
3	icm	53684	810	27492	1777	3	13	1%	24:00:18
4	poznan	5367	37	3917	18	0	0	0%	23:52:11
5	okapi	0	0	0	0	0	2552	0%	24:00:01
TOTAL: 5		118271	3108	77671	2118	3	2565	2%	119:51:36

Outgoing Feeds (innfeed) by Volume:

Server		AcceptVol	RejectVol	TotalVol	Volume/sec	Vol/Art	Elapsed
1	nask	89.5 MB	6.6 MB	96.2 MB	1.1 KB/s	115.7 KB	24:01:16
2	icm	26.0 MB	281.0 MB	307.0 MB	3.6 KB/s	121.5 KB	24:00:18
3	panorama	8.0 MB	6.5 MB	14.5 MB	0.2 KB/s	8.6 KB	23:57:50
4	poznan	288.0 KB	149.9 KB	437.9 KB	0.0 KB/s	8.0 KB	23:52:11
5	okapi	0.0 KB	0.0 KB	0.0 KB	0.0 KB/s	0	24:00:01
TOTAL: 5		123.7 MB	294.3 MB	418.1 MB	1.0 KB/s	81.9 KB	119:51:36

Backlog files shrunk by innfeed:

Server	Size
okapi	488.4 KB
TOTAL: 1	488.4 KB

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Post	Elapsed
1	pc-skrzep2.cm.p.lodz.pl	287	299	432.2 KB	287	0	00:00:07
2	lze200.lze.lodz.pl	4	32	63.7 KB	4	0	00:14:17
3	web.man.lodz.pl	288	18	21.2 KB	9	0	00:00:23
4	isvcs01.man.lodz.pl	1	0	0.0 KB	0	1	00:00:00
TOTAL: 4		580	349	517.0 KB	300	1	00:15:02

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Post	Elapsed
1	*.cm.p.lodz.pl	287	299	432.2 KB	287	0	00:00:07
2	*.lze.lodz.pl	4	32	63.7 KB	4	0	00:14:17
3	*.man.lodz.pl	673	18	21.2 KB	9	1	00:00:28
4	*.toya.net.pl	112	0	0.0 KB	0	0	00:00:08
TOTAL: 4		1076	349	517.0 KB	300	1	00:15:02

NNRP total resource statistics [Top 20]:

System	User(ms)	System(ms)	Elapsed
lze200.lze.lodz.pl	0.027	0.066	00:14:17
web.man.lodz.pl	1.255	3.756	00:00:23
staticline41435.toya.net.pl	0.498	1.382	00:00:08
pc-skrzep2.cm.p.lodz.pl	1.315	3.749	00:00:07
mon.man.lodz.pl	1.286	3.543	00:00:03
david.man.lodz.pl	0.435	1.188	00:00:01
isvcs01.man.lodz.pl	0.009	0.016	00:00:00
TOTAL: 7	4.825	13.700	00:15:02

Curious NNRP server explorers [Top 20]:

System	Conn
mon.man.lodz.pl	288
staticline41435.toya.net.pl	112
david.man.lodz.pl	96
TOTAL: 3	496

Newsgroup request counts (by category):

Category		Count	Pct
1	lodman	299	85.7%
2	pl	50	14.3%
TOTAL: 2		349	100.0%

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

Newsgroup		Count
1	lodman.info	299
2	pl.misc.telefonia.gsm	20
3	pl.comp.pecet	18
4	pl.comp.os.ms-windows.winnt	7
5	pl.rec.kuchnia	5
TOTAL: 5		349

Daily Usenet report

Aug 19 04:15:02 -- Aug 20 04:15:01