usenet.goja.nl.eu.org Daily Usenet report

Mar 6 01:00:00 -- Mar 7 00:04:55

Unknown entries from news log file:

First 3 / 3 lines (100.0%)

Mar 6 01:21:10 goja innd[43164]: filter: No Cancel-Key[sha1:+PPk4KItZZLqzs9vdH+IA6XsASs= sha256:+t3oTM+lvz+rBohoqxR5sWap3As6EOlnkXmLvazXoFA=] matches Cancel-Lock[sha1:ItApuYs6rbo4PBhYUq1fSYNu+bE= sha256:V+/qI7C7VTy8noYhZ3Cm7+hNtLDLy1vefcoTPJ/4mPg=] target=<10od6jv$16fiv$1@gwaiyur.mb-net.net>
Mar 7 00:03:00 goja news2mail[19457]: begin
Mar 7 00:03:00 goja news2mail[30343]: end

Log entries by program:

Program nameLines%LinesSize%Size
nnrpd 38110 69.6%3.4 MB 62.7%
innd 12487 22.8%1.6 MB 28.7%
innfeed 4093 7.5%474.5 KB 8.5%
nocem 30 0.1%3.0 KB 0.1%
inn 7 0.0%1.3 KB 0.0%
news2mail 2 0.0%0.2 KB 0.0%
controlchan 1 0.0%0.2 KB 0.0%
TOTAL: 7 54730 100.0%5.5 MB100.0%

History cache:

ReasonCount%Count
Positive hits 87513 64.1%
Negative hits 33670 24.7%
Do not exist 13801 10.1%
Cache misses 1499 1.1%
TOTAL: 4 136483 100.0%

innd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
artcncl/perl00:00:00.008 0.0%17 0.000 0.471 2.000
article cancel00:00:00.000 0.0%34 0.000 0.000 0.000
article cleanup00:00:00.146 0.0%13798 0.000 0.011 0.045
article logging00:00:00.202 0.0%13839 0.000 0.015 0.051
article parse00:00:00.443 0.0%31113 0.000 0.014 0.037
article write00:00:02.383 0.0%12307 0.067 0.194 0.913
artlog/artcncl/perl00:00:00.001 0.0%17 0.000 0.059 0.333
artlog/artparse00:00:00.000 0.0%2 0.000 0.000 0.000
data move00:00:00.130 0.0%131518 0.000 0.001 0.005
hisgrep/artcncl/perl00:00:00.000 0.0%17 0.000 0.000 0.000
hisgrep/perl00:00:00.005 0.0%37 0.000 0.135 1.000
hishave/artcncl/perl00:00:00.001 0.0%17 0.000 0.059 1.000
hishave/artparse00:00:00.000 0.0%1 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:00.870 0.0%136465 0.000 0.006 0.016
history sync00:00:00.131 0.0%301 0.000 0.435 10.000
history write00:00:01.129 0.0%13797 0.029 0.082 0.221
hiswrite/artparse00:00:00.000 0.0%1 0.000 0.000 0.000
idle22:44:20.904 98.1%140050 333.735 584.512 1719.744
nntp read00:00:03.445 0.0%140810 0.001 0.024 0.084
overview write00:00:02.007 0.0%12307 0.030 0.163 0.634
perl filter00:00:24.713 0.0%13796 1.329 1.791 2.682
python filter00:00:00.677 0.0%13796 0.014 0.049 0.136
site send00:00:01.199 0.0%24636 0.004 0.049 0.250
TOTAL: 2422:44:58.394 98.2%----

innfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.064 0.0%13842 0.000 0.005 0.112
article prepare00:00:00.021 0.0%121928 0.000 0.000 0.002
article read00:00:01.061 0.0%12041 0.000 0.088 0.947
backlog stats00:00:00.412 0.0%273585 0.000 0.002 0.025
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:15.493 0.0%165771 0.010 0.093 0.579
data write00:00:03.882 0.0%156317 0.008 0.025 0.179
idle23:01:00.132 99.8%273585 167.959 302.868 1298.125
status file00:00:00.482 0.0%710 0.000 0.679 2.000
TOTAL: 923:01:21.547 99.9%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle24:33:13.568 98.3%44343 47.500 1993.405 10140.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:25:54.589 1.7%24836340 0.000 0.063 0.500
readart00:00:00.062 0.0%306 0.000 0.203 0.500
TOTAL: 424:59:08.219100.0%----

Control commands to innd:

CommandNumber
flush 6
flushlogs 2
go 2
logmode 2
lowmark 1
mode 145
name 2
pause 2
paused 2
reload 693
reserve 2
TOTAL: 11 859

Incoming feeds (innd):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1goja-out.feeder.erje.net 1125 26625 8242 17877 506 30%99:36:50
2goja-out.news.weretis.net 3 11604 1540 9837 227 13%42:51:43
3newsfeed.endofthelinebbs.com 1 7920 602 7291 27 7%30:21:34
4newsfeed.bofh.team 11 14058 588 13364 106 4%48:47:50
5news.nntp4.net 1 10064 463 9280 321 4%28:00:24
6news.1d4.us 1 4558 237 4087 234 5%24:53:20
7news.samoylyk.net 1 3073 207 2864 2 6%11:31:28
8news.chmurka.net 2 2991 160 2831 0 5%23:59:28
9pasdenom.info 1 3844 102 3734 8 2%23:59:56
10news.quux.org 2 5049 62 4978 9 1%23:58:47
11news.bbs.nz 2 6815 39 6775 1 0%27:29:13
12nntp.terraraq.uk 3 2867 38 2829 0 1%26:44:09
13news.furie.org.uk 1 2719 28 2690 1 1%23:59:57
14newsfeed.dotsrc.org 238 887 8 879 0 0%23:07:43
15goja-out.news.tnetconsulting.net 2 3511 3 3508 0 0%23:57:41
16localhost 1 0 0 0 0 0%00:00:00
TOTAL: 16 1395 106585 12319 92824 1442 11%483:20:03
Articles received by server

Incoming volume (innd):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1goja-out.feeder.erje.net24.4 MB0.0 KB2.1 MB26.5 MB 92%3.1 KB
2goja-out.news.weretis.net4.6 MB0.0 KB496.6 KB5.1 MB 90%2.9 KB
3news.samoylyk.net2.8 MB0.0 KB2.8 KB2.8 MB 99%13.9 KB
4news.nntp4.net1.9 MB0.0 KB2.6 MB4.6 MB 42%6.0 KB
5newsfeed.endofthelinebbs.com1.8 MB1.3 KB158.4 KB2.0 MB 92%3.2 KB
6newsfeed.bofh.team1.7 MB0.0 KB1.7 MB3.3 MB 50%4.9 KB
7news.1d4.us876.4 KB0.0 KB749.5 KB1.6 MB 53%3.5 KB
8news.chmurka.net394.4 KB0.0 KB0.0 KB394.4 KB100%2.5 KB
9pasdenom.info287.2 KB0.0 KB9.4 KB296.6 KB 96%2.7 KB
10nntp.terraraq.uk200.3 KB0.0 KB0.0 KB200.3 KB100%5.3 KB
11news.quux.org104.5 KB0.0 KB25.7 KB130.2 KB 80%1.8 KB
12news.bbs.nz97.5 KB0.0 KB1.7 KB99.2 KB 98%2.5 KB
13news.furie.org.uk75.5 KB0.0 KB13.5 KB88.9 KB 84%3.1 KB
14newsfeed.dotsrc.org61.7 KB0.0 KB0.0 KB61.7 KB100%7.7 KB
15goja-out.news.tnetconsulting.net17.3 KB0.0 KB0.0 KB17.3 KB100%5.8 KB
16localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 1639.3 MB1.3 KB7.8 MB47.2 MB 83%3.5 KB
Incoming volume received by server

Incoming articles (innd):

DateArticles%ArtsArt/secSize%SizeKB/sec
Mar 7 00:00:00 - 00:04:55 6 100.0% 0.0211.8 KB 100.0% 0.04
TOTAL: 00:04:55 6 100.0% 0.0211.8 KB 100.0% 0.04
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1news.nntp4.net 1 1 0 0 0 0 0 0 0
TOTAL: 1 1 1 0 0 0 0 0 0 0

Unwanted newsgroups [Top 20]:

NewsgroupCount
linux.kernel.git 1
TOTAL: 1 1

Perl filter (innd) [Top 20]:

ReasonCount
EMP (phn path) 681
EMP (md5) 105
Too many newsgroups 25
Too many newsgroups (meow) 17
Angle-bracket bot 10
HTML Multipart 4
Cancel of non-existing ID <Dlcib2jzhAoGw9dK0b7_1sLkofM@jntp> 1
Cancel of non-existing ID <fg8yWXYme1rFrqTE93LBK3yjGbg@jntp> 1
Cancel of non-existing ID <pS2Gi79cvxqxwEyL3D0fz1kyswQ@jntp> 1
MID-Bot 1
TOTAL: 10 846

NoCeM on spool:

Issuer (type)NoticesBad PGPCancelSkipTotal
robot@pasdenom.info (spam2)14001717
nocem@eternal-september.org (misplaced_binary)6001515
robot@pasdenom.info (spam3)3001010
robot@pasdenom.info (spam4)20044
TOTAL: 425004646

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Bad command received
newsfeed.dotsrc.org 29
TOTAL: 1 29
Huge articles
newsfeed.bofh.team 1
TOTAL: 1 1
TOTAL: 2 30

Outgoing feeds (innfeed) by articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.bbs.nz 16941 5721 6414 76 0 901 33%23:09:21
2news.chmurka.net 9605 5622 2820 3 0 1 58%23:08:33
3news.1d4.us 7192 3942 2555 1 0 12 54%23:08:02
4newsfeed.dotsrc.org 7248 2696 1085 2923 0 8 37%23:07:53
5news.furie.org.uk 2086 1094 746 0 0 4 52%22:59:31
6nntp.terraraq.uk 3021 730 1482 295 0 0 24%23:06:48
7news.nntp4.net 14117 499 5977 5384 0 7 3%23:08:15
8newsfeed.bofh.team 6273 364 5618 0 0 6 5%23:07:14
9pasdenom.info 8273 325 4504 93 0 24 3%23:07:09
10news.quux.org 11086 222 6302 98 0 54 2%23:06:52
11feeder.erje.net 4459 161 3681 58 0 8 3%23:06:27
12news.samoylyk.net 10772 70 6326 11 0 23 0%23:08:01
13tnetconsulting.net 11107 51 6545 112 0 245 0%22:51:33
14weretis.net 5363 33 4862 1 0 14 0%23:02:02
15newsfeed.endofthelinebbs.com 11580 29 6216 12 0 300 0%23:05:18
16i2pn.org 0 0 0 0 0 6710 0%23:10:00
17peer.alt119.net 0 0 0 0 0 12285 0%23:08:37
TOTAL: 17 129123 21559 65133 9067 0 20602 16%392:41:36
Outgoing feeds (innfeed) by articles

Outgoing feeds (innfeed) by volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.chmurka.net17.0 MB3.1 KB17.0 MB0.2 KB/s3.1 KB23:08:33
2news.bbs.nz12.6 MB127.3 KB12.7 MB0.2 KB/s2.2 KB23:09:21
3news.1d4.us10.8 MB12.5 KB10.8 MB0.1 KB/s2.8 KB23:08:02
4newsfeed.dotsrc.org7.4 MB7.4 MB14.8 MB0.2 KB/s2.7 KB23:07:53
5news.furie.org.uk4.1 MB0.0 KB4.1 MB0.1 KB/s3.9 KB22:59:31
6nntp.terraraq.uk2.1 MB581.7 KB2.6 MB0.0 KB/s2.6 KB23:06:48
7pasdenom.info1.5 MB390.7 KB1.9 MB0.0 KB/s4.6 KB23:07:09
8news.nntp4.net1.1 MB16.5 MB17.6 MB0.2 KB/s3.1 KB23:08:15
9newsfeed.bofh.team901.9 KB0.0 KB901.9 KB0.0 KB/s2.5 KB23:07:14
10news.quux.org778.7 KB166.4 KB945.1 KB0.0 KB/s3.0 KB23:06:52
11feeder.erje.net579.4 KB337.1 KB916.5 KB0.0 KB/s4.2 KB23:06:27
12news.samoylyk.net320.4 KB13.8 KB334.2 KB0.0 KB/s4.1 KB23:08:01
13tnetconsulting.net236.3 KB559.8 KB796.1 KB0.0 KB/s4.9 KB22:51:33
14weretis.net135.7 KB1.3 KB137.0 KB0.0 KB/s4.0 KB23:02:02
15newsfeed.endofthelinebbs.com131.2 KB40.4 KB171.6 KB0.0 KB/s4.2 KB23:05:18
16i2pn.org0.0 KB0.0 KB0.0 KB0.0 KB/s023:10:00
17peer.alt119.net0.0 KB0.0 KB0.0 KB0.0 KB/s023:08:37
TOTAL: 1759.6 MB26.1 MB85.7 MB0.1 KB/s2.9 KB392:41:36
Outgoing feeds (innfeed) by volume

NNRP readership statistics [Top 100]:

SystemConnArtsSizeGroupsPostRejElapsed
166.61.98.95 40 296787.9 KB 14 0 000:51:17
22603:6010:6800:36:1a03:73ff:fe28:be0f 16 1030.7 KB 1 0 000:27:09
TOTAL: 2 56 306818.6 KB 15 0 001:18:27

NNRP connection statistics (by domain) [Top 100]:

SystemConnArtsSizeGroupsPostRejElapsed
1unresolved 333 306818.6 KB 15 0 001:39:53
2*.stehlik.co.uk 406 00.0 KB 0 0 023:18:56
3*.206.censys-scanner.com 3 00.0 KB 0 0 000:00:13
4*.bc.googleusercontent.com 1 00.0 KB 0 0 000:00:00
5*.scanner.modat.io 1 00.0 KB 0 0 000:00:00
TOTAL: 5 744 306818.6 KB 15 0 024:59:03

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
toma-03.stehlik.co.uk 32.462 22.405 28.00123:18:56
66.61.98.95 4.671 2.787 228.60000:51:17
2603:6010:6800:36:1a03:73ff:fe28:be0f 1.905 1.414 14.43000:27:09
2a03:cfc0:8000:b::c303:dce8 20.215 13.918 0.00000:21:24
45.34.168.206.censys-scanner.com 0.160 0.009 0.00000:00:13
205.210.31.146 0.056 0.024 0.00000:00:01
205.210.31.183 0.044 0.022 0.00000:00:00
185.211.203.35.bc.googleusercontent.com 0.047 0.008 0.00000:00:00
o353.scanner.modat.io 0.054 0.008 0.00000:00:00
TOTAL: 9 59.614 40.595 271.03124:59:03

Curious NNRP explorers [Top 20]:

SystemConn
toma-03.stehlik.co.uk 406
2a03:cfc0:8000:b::c303:dce8 275
45.34.168.206.censys-scanner.com 3
185.211.203.35.bc.googleusercontent.com 1
205.210.31.146 1
205.210.31.183 1
o353.scanner.modat.io 1
TOTAL: 7 688

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

SystemConn
185.211.203.35.bc.googleusercontent.com 4
TOTAL: 1 4

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

CommandCount
Accept-Encoding: gzip 1
GET / HTTP/1.1 1
Host: 116.202.108.142:119 1
User-Agent: Hello from Palo Alto Network... 1
TOTAL: 4 4

NNRP client timeouts [Top 20]:

SystemConnPeer
66.61.98.95 1 1
TOTAL: 1 1 5

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

HierarchyCountPct
1it 166 54.2%
2linux 74 24.2%
3pl 32 10.5%
4alt 16 5.2%
5uk 6 2.0%
6comp 4 1.3%
7nl 4 1.3%
8de 2 0.7%
9edm 2 0.7%
TOTAL: 9 306100.0%

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

NewsgroupCount
1it.hobby.fai-da-te 166
2linux.debian.bugs.rc 74
3pl.soc.polityka 32
4alt.jobs 10
5alt.bbs.synchronet 4
6nl.gezondheid.psychiatrie 4
7uk.rec.sheds 4
8alt.home.repair 2
9comp.misc 2
10comp.text.tex 2
11de.soc.arbeitslos 2
12edm.general 2
13uk.religion.christian 2
TOTAL: 13 306