Daily Usenet report

Sep 14 15:00:01 -- Sep 15 15:00:02

Unknown entries from news log file:

First 1 / 1 lines (100.0%)

Sep 14 15:01:00 colo-sc-1 innd: message repeated 2 times: [ ctlinnd command s]

Log entries by program:

Program nameLines%LinesSize%Size
inn 14103 74.8%1.7 MB 72.4%
innd 2827 15.0%397.6 KB 16.5%
innfeed 1309 6.9%184.0 KB 7.6%
cnfsstat 576 3.1%81.3 KB 3.4%
nnrpd 32 0.2%3.2 KB 0.1%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 6 18848 100.0%2.4 MB100.0%

History cache:

ReasonCount%Count
Positive hits 35898 45.0%
Negative hits 30244 37.9%
Do not exist 13678 17.1%
Cache misses 24 0.0%
TOTAL: 4 79844 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:01.132 0.0%71 0.000 15.944 65.222
article cleanup00:00:00.082 0.0%13775 0.000 0.006 0.033
article logging00:00:00.402 0.0%14034 0.000 0.029 0.077
article parse00:00:00.231 0.0%23187 0.000 0.010 0.048
article write00:00:00.960 0.0%12363 0.000 0.078 3.245
artlog/artcncl00:00:00.000 0.0%71 0.000 0.000 0.000
data move00:00:00.054 0.0%87736 0.000 0.001 0.006
hisgrep/artcncl00:00:00.001 0.0%68 0.000 0.015 1.000
hishave/artcncl00:00:00.077 0.0%71 0.000 1.085 7.875
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:18.622 0.0%80414 0.000 0.232 8.330
history sync00:00:00.009 0.0%353 0.000 0.025 0.667
history write00:00:03.520 0.0%13775 0.000 0.256 17.545
hiswrite/artcncl00:00:00.000 0.0%3 0.000 0.000 0.000
idle23:59:51.188 99.9%88028 492.783 981.406 3391.412
nntp read00:00:00.591 0.0%87930 0.000 0.007 0.022
overview write00:00:00.049 0.0%12363 0.000 0.004 0.034
perl filter00:00:14.475 0.0%13775 0.711 1.051 1.444
python filter00:00:00.426 0.0%13775 0.000 0.031 0.105
site send00:00:02.076 0.0%37089 0.013 0.056 0.105
TOTAL: 24:00:48.43124:00:33.895100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.035 0.0%12352 0.000 0.003 0.034
article prepare00:00:00.001 0.0%819 0.000 0.001 0.048
article read00:00:00.031 0.0%379 0.000 0.082 2.500
backlog stats00:00:00.039 0.0%78817 0.000 0.000 0.008
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:00.352 0.0%45124 0.000 0.008 0.027
data write00:00:00.869 0.0%32960 0.000 0.026 0.090
idle23:58:25.362100.0%78817 622.545 1095.009 3012.185
status file00:00:00.815 0.0%280 0.000 2.911 107.000
TOTAL: 23:58:29.44923:58:27.504100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle00:00:00.000 0.0%0 0.000 0.000 0.000
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:00.000 0.0%7 0.000 0.000 0.000
TOTAL: 00:00:00.35400:00:00.000 0.0%----

Control commands to INND:

CommandNumber
flush 5
flushlogs 2
go 2
logmode 2
lowmark 1
mode 147
name 2
pause 2
paused 2
reserve 2
TOTAL: 10 167

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1hasname-out.news.weretis.net 5 24205 8746 14861 598 36%48:05:17
2news-out.aioe.org 3 11913 3345 8568 0 28%23:56:59
3news.nntp4.net 2 12370 120 11531 719 0%22:40:21
4localhost 1 0 0 0 0 0%00:00:00
TOTAL: 4 11 48488 12211 34960 1317 25%94:42:37
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1hasname-out.news.weretis.net26.2 MB0.0 KB1.3 MB27.5 MB 95%3.0 KB
2news-out.aioe.org8.3 MB0.0 KB0.0 KB8.3 MB100%2.5 KB
3news.nntp4.net520.1 KB0.0 KB2.2 MB2.7 MB 18%3.3 KB
4localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 435.0 MB0.0 KB3.4 MB38.5 MB 91%2.9 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Sep 14 15:00:01 - 15:59:59 800 6.5% 0.222.1 MB 6.1% 0.61
Sep 14 16:00:00 - 16:59:59 794 6.4% 0.222.2 MB 6.2% 0.62
Sep 14 17:00:00 - 17:59:59 572 4.6% 0.161.6 MB 4.4% 0.44
Sep 14 18:00:00 - 18:59:59 614 5.0% 0.171.6 MB 4.4% 0.45
Sep 14 19:00:00 - 19:59:59 616 5.0% 0.171.7 MB 4.8% 0.49
Sep 14 20:00:00 - 20:59:59 649 5.2% 0.181.7 MB 4.8% 0.48
Sep 14 21:00:00 - 21:59:59 485 3.9% 0.131.4 MB 3.8% 0.39
Sep 14 22:00:00 - 22:59:59 387 3.1% 0.111.3 MB 3.7% 0.37
Sep 14 23:00:00 - 23:59:59 303 2.5% 0.081.1 MB 3.0% 0.31
Sep 15 00:00:00 - 00:59:59 250 2.0% 0.07834.8 KB 2.3% 0.23
Sep 15 01:00:00 - 01:59:59 283 2.3% 0.08892.0 KB 2.5% 0.25
Sep 15 02:00:00 - 02:59:59 277 2.2% 0.08855.7 KB 2.4% 0.24
Sep 15 03:00:00 - 03:59:59 199 1.6% 0.06778.6 KB 2.1% 0.22
Sep 15 04:00:00 - 04:59:59 239 1.9% 0.07727.9 KB 2.0% 0.20
Sep 15 05:00:00 - 05:59:59 332 2.7% 0.09970.7 KB 2.7% 0.27
Sep 15 06:00:00 - 06:59:59 438 3.5% 0.121.1 MB 3.2% 0.32
Sep 15 07:00:00 - 07:59:59 585 4.7% 0.161.7 MB 4.9% 0.49
Sep 15 08:00:00 - 08:59:59 543 4.4% 0.151.6 MB 4.6% 0.46
Sep 15 09:00:00 - 09:59:59 669 5.4% 0.191.9 MB 5.3% 0.53
Sep 15 10:00:00 - 10:59:59 613 5.0% 0.171.8 MB 5.1% 0.52
Sep 15 11:00:00 - 11:59:59 598 4.8% 0.171.8 MB 5.0% 0.51
Sep 15 12:00:00 - 12:59:59 637 5.2% 0.181.9 MB 5.4% 0.54
Sep 15 13:00:00 - 13:59:59 696 5.6% 0.191.9 MB 5.2% 0.53
Sep 15 14:00:00 - 14:59:59 783 6.3% 0.222.2 MB 6.1% 0.62
Sep 15 15:00:00 - 15:00:02 1 0.0% 0.502.9 KB 0.0% 1.47
TOTAL: 24:00:01 12363 100.0% 0.1435.5 MB 100.0% 0.42
Incoming articles
Incoming articles (size)

CNFS buffer status:

BufferClassSizeUsed%UsedCyclesKB/secDays
FOURDEFAULT1024.0 MB719.0 MB 70.2% 8 0.18 68.25
ONEDEFAULT1024.0 MB896.7 MB 87.6% 10 0.18 66.60
THREEDEFAULT1024.0 MB732.6 MB 71.5% 8 0.18 66.68
TWODEFAULT1024.0 MB727.1 MB 71.0% 8 0.18 68.16
TOTAL: 4-4.0 GB3.0 GB 75.1% 34 0.18-

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1hasname-out.news.weretis.net 840 1 0 0 0 0 0 0 839
2news.nntp4.net 804 14 0 0 1 0 0 0 789
3news-out.aioe.org 26 0 0 0 0 0 0 0 26
TOTAL: 3 1670 15 0 0 1 0 0 0 1654

Unwanted newsgroups [Top 20]:

NewsgroupCount
panix.chat.politics 10
alt.culture 2
alt.alt.alt 1
alt.games.video.sony-playstation 1
alt.music.mandolin 1
TOTAL: 5 15

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

GroupsCount
bit.listserv.catholic 1
TOTAL: 1 1

INND Perl filter [Top 20]:

ReasonCount
EMP (phn path) 708
EMP (md5) 422
EMP (phl) 148
EMP (phn nph) 77
Too many newsgroups 25
Scoring filter 10
HTML Multipart 2
HTML post 2
Too many newsgroups (low_xpost) 1
TOTAL: 9 1395

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
hasname-out.news.weretis.net 235
news-out.aioe.org 24
TOTAL: 2 259
TOTAL: 1 259

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1bbsgslincom 238 238 0 0 0 4100%16:54:16
2aioe 11878 124 8594 6 0 1 1%23:59:52
3nntp4 15618 4 12215 0 0 0 0%23:59:58
4weretis 4785 0 3509 12 0 0 0%23:59:58
TOTAL: 4 32519 366 24318 18 0 5 1%88:54:04
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1bbsgslincom1.1 MB0.0 KB1.1 MB0.0 KB/s4.5 KB16:54:16
2aioe385.1 KB21.7 KB406.8 KB0.0 KB/s3.1 KB23:59:52
3nntp412.2 KB0.0 KB12.2 KB0.0 KB/s3.0 KB23:59:58
4weretis0.0 KB31.0 KB31.0 KB0.0 KB/s2.6 KB23:59:58
TOTAL: 41.4 MB52.7 KB1.5 MB0.0 KB/s4.0 KB88:54:04
Outgoing feeds (innfeed) by Volume

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
50.31.21.6 0.001 0.005 0.00000:00:00
192.241.201.244 0.001 0.001 0.00000:00:00
80.66.88.203 0.002 0.003 0.00000:00:00
scanner-09.ch1.censys-scanner.com 0.001 0.002 0.00000:00:00
? 0.001 0.000 0.00000:00:00
TOTAL: 5 0.006 0.011 0.00000:00:00

NNRP no permission clients:

SystemConn
50.31.21.6 2
80.66.88.203 2
scanner-09.ch1.censys-scanner.com 1
192.241.201.244 1
TOTAL: 4 6

NNRP gethostbyaddr failures [Top 20]:

SystemConn
? (can't getpeername) 1
TOTAL: 1 1