Daily Usenet report: Jun 12 04:15:01

Unknown entries from news log file:

First 12 / 12 lines (100.0%)

Jun 12 10:59:49 newsfeed nnrpd[611178]: SERVER perl filter not defined
Jun 12 10:59:49 newsfeed nnrpd[611178]: SERVER perl filter not defined
Jun 12 11:42:31 newsfeed nnrpd[616441]: SERVER perl filter not defined
Jun 12 11:42:31 newsfeed nnrpd[616441]: SERVER perl filter not defined
Jun 12 12:29:30 newsfeed nnrpd[621897]: SERVER perl filter not defined
Jun 12 12:29:30 newsfeed nnrpd[621897]: SERVER perl filter not defined
Jun 12 14:08:16 newsfeed nnrpd[633719]: SERVER perl filter not defined
Jun 12 14:08:16 newsfeed nnrpd[633719]: SERVER perl filter not defined
Jun 12 16:50:22 newsfeed nnrpd[653055]: SERVER perl filter not defined
Jun 12 16:50:22 newsfeed nnrpd[653055]: SERVER perl filter not defined
Jun 12 19:28:08 newsfeed nnrpd[671928]: SERVER perl filter not defined
Jun 12 19:28:08 newsfeed nnrpd[671928]: SERVER perl filter not defined

Log entries by program:

Program name	Lines	%Lines	Size	%Size
inn	157769	81.3%	17.6 MB	83.6%
innd	18686	9.6%	1.8 MB	8.5%
nnrpd	16372	8.4%	1.5 MB	7.2%
innfeed	1232	0.6%	158.1 KB	0.7%
controlchan	2	0.0%	0.1 KB	0.0%
overchan	2	0.0%	0.3 KB	0.0%
TOTAL: 6	194063	100.0%	21.1 MB	100.0%

History cache:

Reason	Count	%Count
Do not exist	314272	99.8%
Negative hits	480	0.2%
Positive hits	110	0.0%
Cache misses	0	0.0%
TOTAL: 4	314862	100.0%

INND timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article cancel	00:00:00.028	0.0%	76	0.000	0.368	1.000
article cleanup	00:00:00.780	0.0%	315530	0.000	0.002	0.010
article logging	00:00:03.992	0.0%	315588	0.003	0.013	0.023
article parse	00:00:05.518	0.0%	996008	0.001	0.006	0.009
article write	00:00:10.430	0.0%	315522	0.021	0.033	0.059
artlog/artcncl	00:00:00.000	0.0%	10	0.000	0.000	0.000
data move	00:00:00.724	0.0%	1374776	0.000	0.001	0.002
hisgrep/artcncl	00:00:00.012	0.0%	86	0.000	0.140	0.500
hishave/artcncl	00:00:00.000	0.0%	10	0.000	0.000	0.000
history grep	00:00:00.000	0.0%	0	0.000	0.000	0.000
history lookup	00:00:08.528	0.0%	316106	0.000	0.027	0.563
history sync	00:00:00.030	0.0%	608	0.000	0.049	0.500
history write	00:00:26.484	0.0%	315526	0.023	0.084	0.622
idle	47:56:15.800	99.9%	1209220	68.768	142.717	358.663
nntp read	00:00:07.952	0.0%	938586	0.005	0.008	0.014
overview write	00:00:00.386	0.0%	315522	0.000	0.001	0.004
perl filter	00:02:30.370	0.1%	315526	0.303	0.477	0.664
python filter	00:00:00.048	0.0%	315538	0.000	0.000	0.003
site send	00:00:03.836	0.0%	643018	0.002	0.006	0.011
TOTAL: 48:00:34.604	47:59:54.918	100.0%	-	-	-	-

INNfeed timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article new	00:00:00.018	0.0%	11950	0.000	0.002	0.032
article prepare	00:00:00.000	0.0%	472	0.000	0.000	0.000
article read	00:00:00.002	0.0%	118	0.000	0.017	0.250
backlog stats	00:00:00.008	0.0%	74060	0.000	0.000	0.005
callbacks	00:00:00.000	0.0%	0	0.000	0.000	0.000
data read	00:00:00.248	0.0%	34216	0.000	0.007	0.048
data write	00:00:00.694	0.0%	22060	0.000	0.031	0.214
idle	47:42:50.358	100.0%	74060	1233.340	2319.341	8628.753
status file	00:00:00.144	0.0%	314	0.000	0.459	4.000
TOTAL: 47:42:52.264	47:42:51.472	100.0%	-	-	-	-

nnrpd timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
idle	00:03:38.104	80.3%	9018	0.000	24.185	10050.000
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:00:00.292	0.1%	30448	0.000	0.010	0.500
TOTAL: 00:04:31.660	00:03:38.396	80.4%	-	-	-	-

Control commands to INND:

Command	Number
flush	54
flushlogs	4
go	4
logmode	4
lowmark	2
mode	298
name	4
pause	4
paused	4
reload	4
reserve	4
TOTAL: 11	386

Incoming Feeds (INN):

Server		Connects	Offered	Taken	Refused	Reject	%Accpt	Elapsed
1	newsfeed.pionier.net.pl	186	315756	315754	0	2	99%	74:17:04
2	localhost	14	12	12	0	0	100%	00:00:00
3	news.icm.edu.pl	58	104	2	96	6	1%	11:49:16
TOTAL: 3		258	315872	315768	96	8	99%	86:06:20

Incoming Volume (INN):

Server		AcceptVol	DupVol	RejVol	TotalVol	%Acc	Vol/Art
1	newsfeed.pionier.net.pl	2.8 GB	23.9 KB	0.0 KB	2.8 GB	99%	9.2 KB
2	news.icm.edu.pl	23.8 KB	19.0 KB	59.7 KB	102.6 KB	23%	12.8 KB
3	localhost	23.8 KB	0.0 KB	0.0 KB	23.8 KB	100%	2.0 KB
TOTAL: 3		2.8 GB	42.9 KB	59.7 KB	2.8 GB	99%	9.2 KB

Incoming articles:

Date	Articles	%Arts	Art/sec	Size	%Size	KB/sec
Jun 12 04:15:01 - 04:59:59	3212	2.0%	1.19	24.9 MB	1.8%	9.44
Jun 12 05:00:00 - 05:59:59	4610	2.9%	1.28	37.2 MB	2.6%	10.58
Jun 12 06:00:00 - 06:59:59	5780	3.7%	1.61	48.0 MB	3.4%	13.66
Jun 12 07:00:00 - 07:59:59	6781	4.3%	1.88	46.1 MB	3.3%	13.10
Jun 12 08:00:00 - 08:59:59	9018	5.7%	2.50	75.3 MB	5.3%	21.42
Jun 12 09:00:00 - 09:59:59	7957	5.0%	2.21	58.0 MB	4.1%	16.49
Jun 12 10:00:00 - 10:59:59	8500	5.4%	2.36	63.7 MB	4.5%	18.13
Jun 12 11:00:00 - 11:59:59	11163	7.1%	3.10	89.0 MB	6.3%	25.31
Jun 12 12:00:00 - 12:59:59	7469	4.7%	2.07	70.5 MB	5.0%	20.06
Jun 12 13:00:00 - 13:59:59	6610	4.2%	1.84	80.8 MB	5.7%	22.98
Jun 12 14:00:00 - 14:59:59	6464	4.1%	1.80	64.8 MB	4.6%	18.44
Jun 12 15:00:00 - 15:59:59	5990	3.8%	1.66	68.9 MB	4.9%	19.59
Jun 12 16:00:00 - 16:59:59	5237	3.3%	1.45	52.3 MB	3.7%	14.87
Jun 12 17:00:00 - 17:59:59	7377	4.7%	2.05	70.4 MB	5.0%	20.02
Jun 12 18:00:00 - 18:59:59	5443	3.5%	1.51	57.3 MB	4.0%	16.30
Jun 12 19:00:00 - 19:59:59	3960	2.5%	1.10	38.2 MB	2.7%	10.85
Jun 12 20:00:00 - 20:59:59	5554	3.5%	1.54	49.5 MB	3.5%	14.08
Jun 12 21:00:00 - 21:59:59	4467	2.8%	1.24	51.1 MB	3.6%	14.54
Jun 12 22:00:00 - 22:59:59	5518	3.5%	1.53	61.4 MB	4.3%	17.47
Jun 12 23:00:00 - 23:59:59	6696	4.2%	1.86	65.8 MB	4.6%	18.72
Jun 13 00:00:00 - 00:59:59	7652	4.9%	2.13	64.3 MB	4.5%	18.29
Jun 13 01:00:00 - 01:59:59	5407	3.4%	1.50	47.8 MB	3.4%	13.59
Jun 13 02:00:00 - 02:59:59	8425	5.3%	2.34	59.9 MB	4.2%	17.03
Jun 13 03:00:00 - 03:59:59	7209	4.6%	2.00	58.1 MB	4.1%	16.53
Jun 13 04:00:00 - 04:15:01	1232	0.8%	1.37	12.2 MB	0.9%	13.89
TOTAL: 24:00:00	157731	100.0%	1.83	1.4 GB	100.0%	16.77

Sites sending bad articles:

Server		Total	Duplic	Other
1	newsfeed.pionier.net.pl	30	1	29
2	news.icm.edu.pl	3	1	2
TOTAL: 2		33	2	31

INND Perl filter [Top 20]:

Reason	Count
Binary in non-binary group	4
TOTAL: 1	4

Miscellaneous innd statistics [Top 10]:

Event	Server	Number
Including strange strings
	newsfeed.pionier.net.pl	29
	TOTAL: 1	29
TOTAL: 1		29

Outgoing Feeds (innfeed) by Articles:

Server		Offered	Taken	Refused	Reject	%Took	Elapsed
1	icm	22468	114	11856	4	0%	47:56:38
2	poznan	4	0	2	0	0%	00:40:10
TOTAL: 2		22472	114	11858	4	0%	48:36:48

Outgoing Feeds (innfeed) by Volume:

Server		AcceptVol	RejectVol	TotalVol	Vol/Art	Elapsed
1	icm	332.9 KB	289.2 KB	622.2 KB	5.3 KB	47:56:38
2	poznan	0.0 KB	0.0 KB	0.0 KB	0	00:40:10
TOTAL: 2		332.9 KB	289.2 KB	622.2 KB	5.3 KB	48:36:48

NNRP readership statistics:

System		Conn	Post	Elapsed
1	nms2.man.lodz.pl	2880	0	00:00:32
2	zl-dala-us-gp1-wk120c.internet-census.org	2	0	00:00:21
3	193.176.29.20	2	0	00:00:00
4	prod50client01.academyforinternetresearch.org	120	0	00:01:11
5	isvcs01.man.lodz.pl	12	12	00:00:00
6	205.210.31.244	2	0	00:00:00
7	157.230.220.136	32	0	00:00:03
8	sh-chi-us-cpp-wk106.internet-census.org	2	0	00:00:04
9	165.154.12.9	6	0	00:00:21
10	80.111.142.213	8	0	00:00:06
11	zl-laxd-us-cpp-wk111.internet-census.org	2	0	00:00:04
12	204.150.216.162.bc.googleusercontent.com	2	0	00:00:00
13	sh-ams-nl-cpp-wk104.internet-census.org	2	0	00:00:04
14	sh-ams-nl-cpp-wk101.internet-census.org	2	0	00:00:04
15	sh-chi-us-cpp-wk107.internet-census.org	2	0	00:00:05
16	172.16.2.4	574	0	00:00:35
17	54.146.94.167.censys-scanner.com	6	0	00:00:07
18	zl-laxd-us-cpp-wk110.internet-census.org	2	0	00:00:04
19	69.5.169.40	2	0	00:00:00
20	71.6.134.234	2	0	00:00:01
21	azpdwsggbryd.stretchoid.com	4	0	00:00:21
22	159.65.237.176	2	0	00:00:20
23	o351.scanner.modat.io	2	0	00:00:00
TOTAL: 23		3670	12	00:04:32

NNRP readership statistics (by domain):

System		Conn	Post	Elapsed
1	*.146.94.167.censys-scanner.com	6	0	00:00:07
2	*.150.216.162.bc.googleusercontent.com	2	0	00:00:00
3	*.man.lodz.pl	2892	12	00:00:32
4	*.stretchoid.com	4	0	00:00:21
5	*.academyforinternetresearch.org	120	0	00:01:11
6	unresolved	630	0	00:01:30
7	*.scanner.modat.io	2	0	00:00:00
8	*.internet-census.org	14	0	00:00:48
TOTAL: 8		3670	12	00:04:32

NNRP total resource statistics [Top 20]:

System	User(ms)	System(ms)	Elapsed
prod50client01.academyforinternetresearch.org	3.338	0.580	00:01:11
172.16.2.4	1.562	3.044	00:00:35
nms2.man.lodz.pl	8.022	14.432	00:00:32
165.154.12.9	0.016	0.022	00:00:21
azpdwsggbryd.stretchoid.com	0.006	0.024	00:00:21
zl-dala-us-gp1-wk120c.internet-census.org	0.006	0.008	00:00:21
159.65.237.176	0.010	0.006	00:00:20
54.146.94.167.censys-scanner.com	0.076	0.030	00:00:07
80.111.142.213	0.028	0.038	00:00:06
sh-chi-us-cpp-wk107.internet-census.org	0.002	0.014	00:00:05
sh-ams-nl-cpp-wk104.internet-census.org	0.006	0.008	00:00:04
zl-laxd-us-cpp-wk110.internet-census.org	0.000	0.014	00:00:04
zl-laxd-us-cpp-wk111.internet-census.org	0.004	0.012	00:00:04
sh-chi-us-cpp-wk106.internet-census.org	0.008	0.004	00:00:04
sh-ams-nl-cpp-wk101.internet-census.org	0.004	0.008	00:00:04
157.230.220.136	0.074	0.132	00:00:03
71.6.134.234	0.002	0.014	00:00:01
isvcs01.man.lodz.pl	0.038	0.078	00:00:00
205.210.31.244	0.002	0.012	00:00:00
204.150.216.162.bc.googleusercontent.com	0.002	0.012	00:00:00
TOTAL: 23	13.222	18.522	00:04:32

NNRP unrecognized commands (by host) [Top 20]:

System	Conn
157.230.220.136	44
204.150.216.162.bc.googleusercontent.com	8
165.154.12.9	4
azpdwsggbryd.stretchoid.com	2
54.146.94.167.censys-scanner.com	2
TOTAL: 5	60

NNRP unrecognized commands (by command) [Top 20]:

Command	Count
#026#003#001#001	10
À#024#023#001#023#002#023#003#001	10
Host: 212.191.2.21:119	4
GET / HTTP/1.1	4
Accept-Encoding: gzip	4
CSeq: 1	2
PING	2
*1	2
$4	2
#026#003#001	2
EHLO www.censys.io	2
MGLNDD_212.191.2.21_119	2
User-Agent: Hello from Palo Alto Network...	2
À#024	2
User-Agent: Mozilla/5.0 (Android 4.4; Mo...	2
OPTIONS rtsp://192.168.1.148/ RTSP/1.0	2
0#022à7—Mÿ*M#015dÝðT¸š	2
Accept: /	2
#003	2
TOTAL: 19	60

NNRP client timeouts [Top 20]:

System	Conn	Peer
54.146.94.167.censys-scanner.com	2	4
69.5.169.40	2	2
prod50client01.academyforinternetresearch.org	2	2
TOTAL: 3	6	12

Daily Usenet report

Jun 12 04:15:01 -- Jun 13 04:15:01