Daily Usenet report

Dec 2 15:00:04 -- Dec 3 15:00:02

Unknown entries from news log file:

First 1 / 1 lines (100.0%)

Dec 2 15:01:16 colo-sc-1 innd: message repeated 2 times: [ ctlinnd command s]

Log entries by program:

Program nameLines%LinesSize%Size
inn 16483 79.5%2.0 MB 77.2%
innd 2446 11.8%342.8 KB 13.0%
innfeed 1171 5.7%170.9 KB 6.5%
cnfsstat 576 2.8%84.3 KB 3.2%
nnrpd 45 0.2%4.4 KB 0.2%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 6 20722 100.0%2.6 MB100.0%

History cache:

ReasonCount%Count
Negative hits 50273 46.9%
Positive hits 40828 38.1%
Do not exist 15975 14.9%
Cache misses 46 0.0%
TOTAL: 4 107122 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:07.015 0.0%95 0.000 73.842 451.167
article cleanup00:00:00.102 0.0%16077 0.000 0.006 0.034
article logging00:00:00.531 0.0%16384 0.000 0.032 0.116
article parse00:00:00.254 0.0%28718 0.000 0.009 0.036
article write00:00:07.946 0.0%15255 0.000 0.521 22.547
artlog/artcncl00:00:00.004 0.0%95 0.000 0.042 0.500
data move00:00:00.084 0.0%117850 0.000 0.001 0.004
hisgrep/artcncl00:00:00.002 0.0%93 0.000 0.022 0.500
hishave/artcncl00:00:02.554 0.0%95 0.000 26.884 145.500
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:04:44.187 0.3%107768 0.001 2.637 32.321
history sync00:00:00.690 0.0%408 0.000 1.691 224.000
history write00:00:06.271 0.0%16073 0.000 0.390 15.180
hiswrite/artcncl00:00:00.000 0.0%2 0.000 0.000 0.000
idle23:55:13.584 99.6%115724 335.841 744.129 2419.573
nntp read00:00:00.969 0.0%117128 0.000 0.008 0.034
overview write00:00:00.052 0.0%15255 0.000 0.003 0.028
perl filter00:00:22.452 0.0%16073 0.929 1.397 6.590
python filter00:00:00.541 0.0%16073 0.000 0.034 0.093
site send00:00:02.873 0.0%45764 0.027 0.063 0.107
TOTAL: 24:01:07.69724:00:50.111100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.038 0.0%15263 0.000 0.002 0.040
article prepare00:00:00.000 0.0%798 0.000 0.000 0.000
article read00:00:00.028 0.0%543 0.000 0.052 1.000
backlog stats00:00:00.051 0.0%74140 0.000 0.001 0.007
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:00.440 0.0%48511 0.000 0.009 0.030
data write00:00:00.988 0.0%33562 0.000 0.029 0.084
idle23:59:40.093100.0%74140 682.258 1165.094 3142.471
status file00:00:00.058 0.0%214 0.000 0.271 1.000
TOTAL: 23:59:43.80323:59:41.696100.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%9 0.000 0.000 0.000
TOTAL: 00:00:00.11300: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 26199 8982 17116 101 34%46:54:52
2news-out.aioe.org 2 13927 5378 8544 5 38%24:09:01
3news.nntp4.net 3 16029 871 14417 741 5%24:31:25
4localhost 1 0 0 0 0 0%00:00:00
TOTAL: 4 11 56155 15231 40077 847 27%95:35:18
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1hasname-out.news.weretis.net27.9 MB0.0 KB222.3 KB28.2 MB 99%3.2 KB
2news-out.aioe.org14.0 MB21.7 KB22.8 KB14.0 MB 99%2.7 KB
3news.nntp4.net2.1 MB0.0 KB6.1 MB8.2 MB 25%5.2 KB
4localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 444.0 MB21.7 KB6.3 MB50.3 MB 87%3.2 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Dec 2 15:00:04 - 15:59:59 840 5.5% 0.232.2 MB 4.9% 0.62
Dec 2 16:00:00 - 16:59:59 924 6.1% 0.262.6 MB 6.0% 0.74
Dec 2 17:00:00 - 17:59:59 923 6.0% 0.262.7 MB 6.2% 0.78
Dec 2 18:00:00 - 18:59:59 815 5.3% 0.232.4 MB 5.5% 0.69
Dec 2 19:00:00 - 19:59:59 938 6.1% 0.262.9 MB 6.6% 0.82
Dec 2 20:00:00 - 20:59:59 842 5.5% 0.232.2 MB 5.0% 0.62
Dec 2 21:00:00 - 21:59:59 741 4.9% 0.212.1 MB 4.9% 0.61
Dec 2 22:00:00 - 22:59:59 581 3.8% 0.161.8 MB 4.1% 0.51
Dec 2 23:00:00 - 23:59:59 617 4.0% 0.172.2 MB 5.0% 0.63
Dec 3 00:00:00 - 00:59:59 399 2.6% 0.111.5 MB 3.4% 0.43
Dec 3 01:00:00 - 01:59:59 299 2.0% 0.08972.1 KB 2.2% 0.27
Dec 3 02:00:00 - 02:59:59 276 1.8% 0.081001.4 KB 2.2% 0.28
Dec 3 03:00:00 - 03:59:59 282 1.8% 0.081008.0 KB 2.2% 0.28
Dec 3 04:00:00 - 04:59:59 227 1.5% 0.06767.0 KB 1.7% 0.21
Dec 3 05:00:00 - 05:59:59 278 1.8% 0.081.0 MB 2.3% 0.29
Dec 3 06:00:00 - 06:59:59 379 2.5% 0.11967.2 KB 2.2% 0.27
Dec 3 07:00:00 - 07:59:59 485 3.2% 0.131.2 MB 2.8% 0.35
Dec 3 08:00:00 - 08:59:59 564 3.7% 0.161.4 MB 3.3% 0.41
Dec 3 09:00:00 - 09:59:59 802 5.3% 0.222.1 MB 4.8% 0.60
Dec 3 10:00:00 - 10:59:59 698 4.6% 0.191.7 MB 3.9% 0.49
Dec 3 11:00:00 - 11:59:59 705 4.6% 0.202.0 MB 4.7% 0.58
Dec 3 12:00:00 - 12:59:59 790 5.2% 0.221.9 MB 4.4% 0.55
Dec 3 13:00:00 - 13:59:59 911 6.0% 0.252.4 MB 5.5% 0.69
Dec 3 14:00:00 - 15:00:02 943 6.2% 0.262.7 MB 6.2% 0.77
TOTAL: 23:59:58 15259 100.0% 0.1843.8 MB 100.0% 0.52
Incoming articles
Incoming articles (size)

CNFS buffer status:

BufferClassSizeUsed%UsedCyclesKB/secDays
FOURDEFAULT1024.0 MB296.2 MB 28.9% 4 0.22 54.97
ONEDEFAULT1024.0 MB458.9 MB 44.8% 6 0.22 55.69
THREEDEFAULT1024.0 MB298.3 MB 29.1% 4 0.23 53.92
TWODEFAULT1024.0 MB294.2 MB 28.7% 4 0.23 52.80
TOTAL: 4-4.0 GB1.3 GB 32.9% 18 0.22-

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1news.nntp4.net 709 8 0 0 1 0 0 0 700
2hasname-out.news.weretis.net 372 0 0 0 0 0 0 0 372
3news-out.aioe.org 48 0 0 4 0 0 0 0 44
TOTAL: 3 1129 8 0 4 1 0 0 0 1116

Unwanted newsgroups [Top 20]:

NewsgroupCount
alt.russia 3
panix.chat 1
panix.chat.politics 1
0.test 1
alt.test.1 1
alt.sports.baseball 1
TOTAL: 6 8

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

GroupsCount
bit.listserv.catholic 1
TOTAL: 1 1

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 574
EMP (phn path) 187
User-issued spam cancel 29
EMP (phl) 13
HTML Multipart 2
Too many newsgroups 2
Binary: misplaced binary 1
TOTAL: 7 808

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
hasname-out.news.weretis.net 261
news-out.aioe.org 43
news.nntp4.net 4
TOTAL: 3 308
TOTAL: 1 308

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1bbsgslincom 458 458 0 0 0 0100%21:44:25
2aioe 10847 19 9746 2 0 7 0%23:59:55
3nntp4 15402 3 14371 0 0 0 0%23:59:55
4weretis 6282 1 6175 60 0 0 0%23:59:54
TOTAL: 4 32989 481 30292 62 0 7 1%93:44:09
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1bbsgslincom1.6 MB0.0 KB1.6 MB0.0 KB/s3.5 KB21:44:25
2aioe154.2 KB2.6 KB156.8 KB0.0 KB/s7.5 KB23:59:55
3nntp412.4 KB0.0 KB12.4 KB0.0 KB/s4.1 KB23:59:55
4weretis4.1 KB242.7 KB246.9 KB0.0 KB/s4.0 KB23:59:54
TOTAL: 41.7 MB245.3 KB2.0 MB0.0 KB/s3.7 KB93:44:09
Outgoing feeds (innfeed) by Volume

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
159.223.27.33 0.005 0.016 0.00000:00:00
TOTAL: 1 0.005 0.016 0.00000:00:00

NNRP no permission clients:

SystemConn
159.223.27.33 9
TOTAL: 1 9