Daily Usenet report: Jan 7 04:15:02

Unknown entries from news log file:

First 9 / 9 lines (100.0%)

Jan 7 11:04:15 newsfeed nnrpd[23082]: SERVER perl filter not defined
Jan 7 13:41:49 newsfeed nnrpd[28335]: SERVER perl filter not defined
Jan 7 13:45:29 newsfeed nnrpd[28421]: SERVER perl filter not defined
Jan 7 13:57:09 newsfeed nnrpd[28754]: SERVER perl filter not defined
Jan 7 13:57:43 newsfeed nnrpd[28792]: SERVER perl filter not defined
Jan 7 14:19:45 newsfeed nnrpd[29486]: SERVER perl filter not defined
Jan 7 14:23:12 newsfeed nnrpd[29721]: SERVER perl filter not defined
Jan 7 14:24:33 newsfeed nnrpd[29722]: SERVER perl filter not defined
Jan 7 15:59:34 newsfeed nnrpd[372]: SERVER perl filter not defined

Log entries by program:

Program name	Lines	%Lines	Size	%Size
inn	694856	96.6%	78.3 MB	95.9%
innd	10602	1.5%	1.7 MB	2.1%
nnrpd	7463	1.0%	765.4 KB	0.9%
innfeed	6443	0.9%	910.8 KB	1.1%
TOTAL: 4	719364	100.0%	81.7 MB	100.0%

History cache:

Reason	Count	%Count
Do not exist	691162	94.8%
Negative hits	20000	2.7%
Positive hits	18018	2.5%
Cache misses	170	0.0%
TOTAL: 4	729350	100.0%

INND timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article cancel	00:00:08.939	0.0%	322	0.000	27.761	486.000
article cleanup	00:00:10.420	0.0%	695336	0.000	0.015	0.043
article logging	00:00:19.300	0.0%	695448	0.000	0.028	0.199
article parse	00:22:12.509	1.5%	56541205	0.009	0.024	0.069
article write	00:06:20.360	0.4%	691420	0.167	0.550	4.215
artlog/artcncl	00:00:00.006	0.0%	310	0.000	0.019	1.000
artlog/artparse	00:00:00.000	0.0%	2	0.000	0.000	0.000
data move	00:00:58.492	0.1%	60620381	0.000	0.001	0.009
hisgrep/artcncl	00:00:01.514	0.0%	284	0.000	5.331	54.000
hishave/artcncl	00:00:00.628	0.0%	322	0.000	1.950	29.000
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	00:53:48.240	3.7%	731229	0.848	4.415	10.853
history sync	00:00:00.018	0.0%	450	0.000	0.040	1.000
history write	00:51:15.720	3.6%	693245	1.428	4.437	19.843
hiswrite/artcncl	00:00:00.106	0.0%	38	0.000	2.789	22.000
idle	19:33:19.649	81.5%	44546438	0.339	1.580	13.564
nntp read	00:22:16.041	1.5%	56068260	0.011	0.024	0.052
overview write	00:00:04.423	0.0%	691420	0.000	0.006	0.031
perl filter	01:27:06.546	6.0%	693243	3.100	7.539	13.000
python filter	00:00:00.000	0.0%	0	0.000	0.000	0.000
site send	00:01:30.314	0.1%	1417108	0.005	0.064	0.131
TOTAL: 24:00:05.270	23:39:33.225	98.6%	-	-	-	-

INNfeed timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article new	00:00:00.100	0.0%	34286	0.000	0.003	0.125
article prepare	00:00:00.003	0.0%	8824	0.000	0.000	0.250
article read	00:00:00.134	0.0%	2171	0.000	0.062	1.000
backlog stats	00:00:00.119	0.0%	223204	0.000	0.001	0.019
callbacks	00:00:00.000	0.0%	0	0.000	0.000	0.000
data read	00:00:01.314	0.0%	141072	0.000	0.009	1.000
data write	00:00:03.429	0.0%	106579	0.000	0.032	4.000
idle	23:59:30.660	100.0%	223204	0.000	386.958	27431.000
status file	00:00:01.094	0.0%	188	0.000	5.819	218.000
TOTAL: 23:59:41.934	23:59:36.853	100.0%	-	-	-	-

nnrpd timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
idle	06:11:01.941	99.9%	11569	0.000	1924.275	450070.500
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:00:00.666	0.0%	26799	0.000	0.025	1.833
readart	00:00:06.621	0.0%	1290	0.000	5.133	169.000
TOTAL: 06:11:28.687	06:11:09.228	99.9%	-	-	-	-

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	396	691772	688258	114	3400	99%	161:13:58
2	news.nask.pl	3	17697	2134	15100	463	12%	23:15:56
3	news.icm.edu.pl	47	269	25	193	51	9%	16:53:38
4	localhost	10	9	9	0	0	100%	00:00:00
TOTAL: 4		456	709747	690426	15407	3914	97%	201:23:32

Incoming Volume (INN):

Server		AcceptVol	DupVol	RejVol	TotalVol	%Acc	Vol/Art
1	newsfeed.pionier.net.pl	176.4 GB	8.8 MB	152.9 MB	176.5 GB	99%	267.6 KB
2	news.nask.pl	9.9 MB	1.2 MB	1.2 MB	12.4 MB	80%	4.9 KB
3	news.icm.edu.pl	1.0 MB	70.6 KB	564.2 KB	1.6 MB	62%	22.0 KB
4	localhost	11.9 KB	0.0 KB	0.0 KB	11.9 KB	100%	1.3 KB
TOTAL: 4		176.4 GB	10.1 MB	154.7 MB	176.5 GB	99%	266.6 KB

Incoming articles:

Date	Articles	%Arts	Art/sec	Size	%Size	KB/sec
Jan 7 04:15:02 - 04:59:59	49378	7.2%	18.30	13.9 GB	7.9%	5408.65
Jan 7 05:00:00 - 05:59:59	62030	9.0%	17.23	17.6 GB	10.0%	5128.17
Jan 7 06:00:00 - 06:59:59	60197	8.7%	16.72	17.0 GB	9.6%	4946.48
Jan 7 07:00:00 - 07:59:59	92264	13.4%	25.63	26.7 GB	15.1%	7772.23
Jan 7 08:00:00 - 08:59:59	62770	9.1%	17.44	19.5 GB	11.0%	5666.69
Jan 7 09:00:00 - 09:59:59	11408	1.7%	3.17	2.1 GB	1.2%	624.92
Jan 7 10:00:00 - 10:59:59	11911	1.7%	3.31	2.3 GB	1.3%	659.26
Jan 7 11:00:00 - 11:59:59	11410	1.7%	3.17	1.9 GB	1.1%	549.04
Jan 7 12:00:00 - 12:59:59	11371	1.6%	3.16	2.0 GB	1.1%	579.06
Jan 7 13:00:00 - 13:59:59	12768	1.8%	3.55	2.0 GB	1.1%	585.86
Jan 7 14:00:00 - 14:59:59	12817	1.9%	3.56	1.9 GB	1.1%	551.39
Jan 7 15:00:00 - 15:59:59	12850	1.9%	3.57	1.6 GB	0.9%	480.39
Jan 7 16:00:00 - 16:59:59	12517	1.8%	3.48	1.8 GB	1.0%	510.46
Jan 7 17:00:00 - 17:59:59	10720	1.6%	2.98	1.4 GB	0.8%	415.03
Jan 7 18:00:00 - 18:59:59	10031	1.5%	2.79	1.5 GB	0.8%	432.54
Jan 7 19:00:00 - 19:59:59	11620	1.7%	3.23	2.0 GB	1.1%	574.42
Jan 7 20:00:00 - 20:59:59	14079	2.0%	3.91	1.9 GB	1.1%	558.56
Jan 7 21:00:00 - 21:59:59	13266	1.9%	3.69	1.9 GB	1.1%	564.06
Jan 7 22:00:00 - 22:59:59	12329	1.8%	3.42	1.9 GB	1.1%	549.38
Jan 7 23:00:00 - 23:59:59	9609	1.4%	2.67	1.5 GB	0.8%	429.64
Jan 8 00:00:00 - 00:59:59	35085	5.1%	9.75	9.7 GB	5.5%	2833.47
Jan 8 01:00:00 - 01:59:59	49176	7.1%	13.66	14.1 GB	8.0%	4113.02
Jan 8 02:00:00 - 02:59:59	42337	6.1%	11.76	12.9 GB	7.3%	3755.63
Jan 8 03:00:00 - 03:59:59	46997	6.8%	13.05	13.7 GB	7.8%	3989.28
Jan 8 04:00:00 - 04:15:02	11578	1.7%	12.84	3.7 GB	2.1%	4287.96
TOTAL: 24:00:00	690518	100.0%	7.99	176.5 GB	100.0%	2141.53

Sites sending bad articles:

Server		Total	Group	Duplic	Unapp	Other
1	newsfeed.pionier.net.pl	3503	390	1633	0	1480
2	news.nask.pl	474	9	455	2	8
3	news.icm.edu.pl	51	0	3	0	48
TOTAL: 3		4028	399	2091	2	1536

Unwanted newsgroups [Top 20]:

Newsgroup	Count
uk.railway	266
it.tlc.cellulari.android	20
comp.mobile.android	20
uk.rec.cycling.moderated	17
comp.sys.mac.vintage	15
nl.comp.sys.android	12
uk.net.providers.gradwell	11
it.comp.os.win.windows7	7
comp.mobile.ipad	5
comp.sys.raspberry-pi	4
hr.ponuda.hardver.komponente	4
it.comp.os.win.windows8	4
de.comp.lang.php	3
hr.ponuda.hardver.konfiguracije	3
it.comp.virtualizzazione	2
alt.sex.telephones	2
de.comp.lang.vbclassic	1
nl.wetenschap.regulier	1
dk.test.utf8-Ã¦Ã¸Ã¥	1
it.discussioni.energia	1
TOTAL: 20	399

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

Groups	Count
bit.listserv.catholic	1
pl.sci.historia	1
TOTAL: 2	2

INND Perl filter [Top 20]:

Reason	Count
Binary in non-binary group	1324
EMP (md5)	90
HTML post	7
Attached HTML file	1
TOTAL: 4	1422

Outgoing Feeds (innfeed) by Articles:

Server		Offered	Taken	Refused	Reject	Spool	%Took	Elapsed
1	panorama	34885	1008	33026	155	0	2%	23:55:25
2	icm	40194	293	29253	592	26	0%	23:57:30
3	nask	28161	120	16351	3	1	0%	23:59:43
4	poznan	2708	7	1986	4	0	0%	23:53:28
5	okapi	0	0	0	0	2693	0%	24:00:00
TOTAL: 5		105948	1428	80616	754	2720	1%	119:46:06

Outgoing Feeds (innfeed) by Volume:

Server		AcceptVol	RejectVol	TotalVol	Volume/sec	Vol/Art	Elapsed
1	panorama	5.0 MB	600.7 KB	5.6 MB	0.1 KB/s	4.9 KB	23:55:25
2	icm	2.7 MB	89.2 MB	91.8 MB	1.1 KB/s	106.3 KB	23:57:30
3	nask	1.5 MB	10.0 KB	1.5 MB	0.0 KB/s	12.4 KB	23:59:43
4	poznan	52.2 KB	7.0 KB	59.2 KB	0.0 KB/s	5.4 KB	23:53:28
5	okapi	0.0 KB	0.0 KB	0.0 KB	0.0 KB/s	0	24:00:00
TOTAL: 5		9.2 MB	89.8 MB	99.0 MB	0.2 KB/s	46.4 KB	119:46:06

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-212-51-218-225.p.lodz.pl	11	848	2.0 MB	8	0	05:01:20
2	pc-skrzep2.cm.p.lodz.pl	288	350	533.4 KB	288	0	00:00:07
3	web.man.lodz.pl	288	92	72.4 KB	39	0	00:00:21
4	isvcs01.man.lodz.pl	9	0	0.0 KB	0	9	00:00:00
TOTAL: 4		596	1290	2.6 MB	335	9	06:11:28

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Post	Elapsed
1	*.p.lodz.pl	11	848	2.0 MB	8	0	05:01:20
2	*.cm.p.lodz.pl	288	350	533.4 KB	288	0	00:00:07
3	*.man.lodz.pl	681	92	72.4 KB	39	9	00:00:27
4	*.191.14.62.static.jazztel.es	6	0	0.0 KB	0	0	00:37:34
5	*.elsnet.pl	2	0	0.0 KB	0	0	00:00:06
6	unresolved	2	0	0.0 KB	0	0	00:31:05
7	*.toya.net.pl	120	0	0.0 KB	0	0	00:00:45
TOTAL: 7		1110	1290	2.6 MB	335	9	06:11:28

NNRP total resource statistics [Top 20]:

System	User(ms)	System(ms)	Elapsed
pc-212-51-218-225.p.lodz.pl	0.136	0.416	05:01:20
37.191.14.62.static.jazztel.es	0.268	0.508	00:37:34
212.51.203.199	0.004	0.040	00:31:05
staticline41435.toya.net.pl	0.405	2.289	00:00:45
web.man.lodz.pl	0.964	5.529	00:00:21
pc-skrzep2.cm.p.lodz.pl	1.103	5.513	00:00:07
host227.elsnet.pl	0.007	0.036	00:00:06
mon.man.lodz.pl	1.036	5.264	00:00:04
david.man.lodz.pl	0.330	1.751	00:00:01
isvcs01.man.lodz.pl	0.055	0.173	00:00:00
TOTAL: 10	4.308	21.519	06:11:28

Curious NNRP server explorers [Top 20]:

System	Conn
mon.man.lodz.pl	288
staticline41435.toya.net.pl	120
david.man.lodz.pl	96
37.191.14.62.static.jazztel.es	6
host227.elsnet.pl	2
212.51.203.199	2
TOTAL: 6	514

NNRP client timeouts [Top 20]:

System	Conn	Peer
pc-212-51-218-225.p.lodz.pl	5	0
37.191.14.62.static.jazztel.es	2	0
212.51.203.199	1	0
TOTAL: 3	8	0

Newsgroup request counts (by category):

Category		Count	Pct
1	pl	934	72.4%
2	lodman	356	27.6%
TOTAL: 2		1290	100.0%

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

Newsgroup		Count
1	pl.misc.kolej	514
2	lodman.info	350
3	pl.misc.elektronika	334
4	pl.comp.pecet	58
5	pl.comp.os.ms-windows.winnt	28
6	lodman.test	6
TOTAL: 6		1290

Daily Usenet report

Jan 7 04:15:02 -- Jan 8 04:15:02