Daily Usenet report: Jul 25 04:15:01

Unknown entries from news log file:

First 6 / 6 lines (100.0%)

Jul 25 09:44:10 newsfeed nnrpd[151034]: SERVER perl filter not defined
Jul 25 09:44:10 newsfeed nnrpd[151034]: SERVER perl filter not defined
Jul 25 09:49:28 newsfeed nnrpd[151646]: SERVER perl filter not defined
Jul 25 09:49:28 newsfeed nnrpd[151646]: SERVER perl filter not defined
Jul 25 15:41:11 newsfeed nnrpd[194056]: SERVER perl filter not defined
Jul 25 15:41:11 newsfeed nnrpd[194056]: SERVER perl filter not defined

Log entries by program:

Program name	Lines	%Lines	Size	%Size
inn	216009	81.0%	23.9 MB	83.6%
innd	33778	12.7%	3.1 MB	10.8%
nnrpd	15782	5.9%	1.5 MB	5.2%
innfeed	1218	0.5%	135.2 KB	0.5%
overchan	2	0.0%	0.3 KB	0.0%
controlchan	2	0.0%	0.1 KB	0.0%
TOTAL: 6	266791	100.0%	28.6 MB	100.0%

History cache:

Reason	Count	%Count
Do not exist	430666	99.8%
Negative hits	652	0.2%
Cache misses	162	0.0%
Positive hits	92	0.0%
TOTAL: 4	431572	100.0%

INND timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article cancel	00:00:00.008	0.0%	90	0.000	0.089	1.000
article cleanup	00:00:01.098	0.0%	431254	0.000	0.003	0.008
article logging	00:00:05.106	0.0%	431758	0.006	0.012	0.021
article parse	00:00:08.572	0.0%	1620690	0.003	0.005	0.010
article write	00:00:15.018	0.0%	431104	0.021	0.035	0.092
artlog/artcncl	00:00:00.000	0.0%	30	0.000	0.000	0.000
data move	00:00:01.044	0.0%	2389336	0.000	0.000	0.002
hisgrep/artcncl	00:00:00.000	0.0%	120	0.000	0.000	0.000
hishave/artcncl	00:00:00.000	0.0%	30	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:01.804	0.0%	431980	0.000	0.004	0.015
history sync	00:00:00.030	0.0%	700	0.000	0.043	1.000
history write	00:00:19.460	0.0%	431104	0.024	0.045	0.096
idle	47:55:54.370	99.8%	1934052	51.294	89.219	186.477
nntp read	00:00:12.682	0.0%	1557382	0.004	0.008	0.013
overview write	00:00:00.702	0.0%	431104	0.000	0.002	0.005
perl filter	00:03:47.886	0.1%	431104	0.432	0.529	0.689
python filter	00:00:00.096	0.0%	431110	0.000	0.000	0.002
site send	00:00:06.040	0.0%	874882	0.003	0.007	0.013
TOTAL: 48:01:29.210	48:00:53.916	100.0%	-	-	-	-

INNfeed timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
article new	00:00:00.024	0.0%	12658	0.000	0.002	0.083
article prepare	00:00:00.000	0.0%	408	0.000	0.000	0.000
article read	00:00:00.006	0.0%	102	0.000	0.059	1.000
backlog stats	00:00:00.016	0.0%	81776	0.000	0.000	0.008
callbacks	00:00:00.000	0.0%	0	0.000	0.000	0.000
data read	00:00:00.290	0.0%	37442	0.000	0.008	0.035
data write	00:00:00.908	0.0%	24648	0.000	0.037	0.143
idle	47:56:57.432	100.0%	81776	981.688	2110.857	8963.567
status file	00:00:00.164	0.0%	314	0.000	0.522	4.000
TOTAL: 47:57:00.722	47:56:58.840	100.0%	-	-	-	-

nnrpd timer:

Code region	Time	Pct	Invoked	Min(ms)	Avg(ms)	Max(ms)
idle	00:01:17.454	73.6%	8838	1.000	8.764	4020.000
newnews	00:00:00.000	0.0%	0	0.000	0.000	0.000
nntpwrite	00:00:00.228	0.2%	30010	0.000	0.008	0.333
readart	00:00:00.002	0.0%	8	0.250	0.250	0.250
TOTAL: 00:01:45.224	00:01:17.684	73.8%	-	-	-	-

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	112	431386	431228	8	150	99%	67:22:46
2	localhost	8	6	6	0	0	100%	00:00:00
3	news.icm.edu.pl	48	66	0	66	0	0%	09:06:36
TOTAL: 3		168	431458	431234	74	150	99%	76:29:22

Incoming Volume (INN):

Server		AcceptVol	DupVol	TotalVol	%Acc	Vol/Art
1	newsfeed.pionier.net.pl	4.7 GB	2.4 MB	4.7 GB	99%	11.4 KB
2	localhost	8.6 KB	0.0 KB	8.6 KB	100%	1.4 KB
3	news.icm.edu.pl	0.0 KB	0.0 KB	0.0 KB	0%	0
TOTAL: 3		4.7 GB	2.4 MB	4.7 GB	99%	11.4 KB

Incoming articles:

Date	Articles	%Arts	Art/sec	Size	%Size	KB/sec
Jul 25 04:15:01 - 04:59:59	7824	3.6%	2.90	80.3 MB	3.3%	30.47
Jul 25 05:00:00 - 05:59:59	9471	4.4%	2.63	107.4 MB	4.5%	30.54
Jul 25 06:00:00 - 06:59:59	8038	3.7%	2.23	95.2 MB	4.0%	27.07
Jul 25 07:00:00 - 07:59:59	8309	3.9%	2.31	90.0 MB	3.8%	25.60
Jul 25 08:00:00 - 08:59:59	9575	4.4%	2.66	100.0 MB	4.2%	28.45
Jul 25 09:00:00 - 09:59:59	10392	4.8%	2.89	102.8 MB	4.3%	29.25
Jul 25 10:00:00 - 10:59:59	11082	5.1%	3.08	106.5 MB	4.4%	30.30
Jul 25 11:00:00 - 11:59:59	8609	4.0%	2.39	97.7 MB	4.1%	27.79
Jul 25 12:00:00 - 12:59:59	7197	3.3%	2.00	79.4 MB	3.3%	22.59
Jul 25 13:00:00 - 13:59:59	8721	4.0%	2.42	85.6 MB	3.6%	24.34
Jul 25 14:00:00 - 14:59:59	6752	3.1%	1.88	69.5 MB	2.9%	19.78
Jul 25 15:00:00 - 15:59:59	7238	3.4%	2.01	81.8 MB	3.4%	23.26
Jul 25 16:00:00 - 16:59:59	6702	3.1%	1.86	74.2 MB	3.1%	21.10
Jul 25 17:00:00 - 17:59:59	8202	3.8%	2.28	85.5 MB	3.6%	24.32
Jul 25 18:00:00 - 18:59:59	10267	4.8%	2.85	120.8 MB	5.0%	34.35
Jul 25 19:00:00 - 19:59:59	7278	3.4%	2.02	83.2 MB	3.5%	23.65
Jul 25 20:00:00 - 20:59:59	11210	5.2%	3.11	150.3 MB	6.3%	42.75
Jul 25 21:00:00 - 21:59:59	8886	4.1%	2.47	115.2 MB	4.8%	32.75
Jul 25 22:00:00 - 22:59:59	10767	5.0%	2.99	130.0 MB	5.4%	36.97
Jul 25 23:00:00 - 23:59:59	12884	6.0%	3.58	130.0 MB	5.4%	36.98
Jul 26 00:00:00 - 00:59:59	10180	4.7%	2.83	112.8 MB	4.7%	32.07
Jul 26 01:00:00 - 01:59:59	9768	4.5%	2.71	108.8 MB	4.5%	30.94
Jul 26 02:00:00 - 02:59:59	7950	3.7%	2.21	96.7 MB	4.0%	27.50
Jul 26 03:00:00 - 03:59:59	6673	3.1%	1.85	75.2 MB	3.1%	21.39
Jul 26 04:00:00 - 04:15:01	1692	0.8%	1.88	19.4 MB	0.8%	22.09
TOTAL: 24:00:00	215667	100.0%	2.50	2.3 GB	100.0%	28.42

Sites sending bad articles:

Server		Total	Group	Dist	Duplic	Unapp	TooOld	Site	Line	Other
1	newsfeed.pionier.net.pl	327	0	0	75	0	0	0	0	252
TOTAL: 1		327	0	0	75	0	0	0	0	252

Miscellaneous innd statistics [Top 10]:

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

Outgoing Feeds (innfeed) by Articles:

Server		Offered	Taken	Refused	Reject	%Took	Elapsed
1	icm	24782	92	12560	10	0%	47:59:48
2	poznan	0	0	0	0	0%	00:20:00
TOTAL: 2		24782	92	12560	10	0%	48:19:48

Outgoing Feeds (innfeed) by Volume:

Server		AcceptVol	RejectVol	TotalVol	Vol/Art	Elapsed
1	icm	256.5 KB	18.3 KB	274.8 KB	2.7 KB	47:59:48
2	poznan	0.0 KB	0.0 KB	0.0 KB	0	00:20:00
TOTAL: 2		256.5 KB	18.3 KB	274.8 KB	2.7 KB	48:19:48

NNRP readership statistics:

System		Conn	Arts	Size	Groups	Post	Elapsed
1	syn-066-061-098-095.res.spectrum.com	12	8	6.8 KB	2	0	00:00:22
2	isvcs01.man.lodz.pl	6	0	0.0 KB	0	6	00:00:00
TOTAL: 2		18	8	6.8 KB	2	6	00:01:46

NNRP readership statistics (by domain):

System		Conn	Arts	Size	Groups	Post	Elapsed
1	*.res.spectrum.com	12	8	6.8 KB	2	0	00:00:22
2	*.man.lodz.pl	2886	0	0.0 KB	0	6	00:00:22
3	unresolved	602	0	0.0 KB	0	0	00:01:01
TOTAL: 3		3500	8	6.8 KB	2	6	00:01:46

NNRP total resource statistics [Top 20]:

System	User(ms)	System(ms)	Elapsed
172.16.2.4	1.330	2.676	00:00:33
nms1.man.lodz.pl	6.042	12.672	00:00:22
syn-066-061-098-095.res.spectrum.com	0.034	0.058	00:00:22
162.142.125.217	0.074	0.028	00:00:09
167.94.146.57	0.072	0.030	00:00:07
80.111.142.213	0.022	0.036	00:00:05
147.185.132.63	0.006	0.006	00:00:02
104.152.52.115	0.008	0.006	00:00:01
205.210.31.225	0.002	0.012	00:00:01
147.185.132.224	0.002	0.012	00:00:00
isvcs01.man.lodz.pl	0.022	0.026	00:00:00
TOTAL: 11	7.614	15.562	00:01:46

Curious NNRP server explorers [Top 20]:

System	Conn
nms1.man.lodz.pl	2880
172.16.2.4	574
80.111.142.213	8
162.142.125.217	6
167.94.146.57	6
205.210.31.225	2
147.185.132.224	2
147.185.132.63	2
104.152.52.115	2
TOTAL: 9	3482

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

System	Conn
147.185.132.224	8
104.152.52.115	4
167.94.146.57	2
162.142.125.217	2
TOTAL: 4	16

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

Command	Count
EHLO www.censys.io	4
Host: 212.191.2.21:119	2
User-Agent: Hello from Palo Alto Network...	2
MAIL FROM:<relaycheck_please_ignore@prot...	2
Accept-Encoding: gzip	2
GET / HTTP/1.1	2
EHLO 212.191.2.21	2
TOTAL: 7	16

NNRP client timeouts [Top 20]:

System	Conn	Peer
167.94.146.57	2	4
162.142.125.217	2	4
TOTAL: 2	4	12

Newsgroup request counts (by hierarchy):

Hierarchy		Count	Pct
1	lodman	8	100.0%
TOTAL: 1		8	100.0%

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

Newsgroup		Count
1	lodman.test	8
TOTAL: 1		8

Daily Usenet report

Jul 25 04:15:01 -- Jul 26 04:15:01