Daily Usenet report

May 10 15:00:12 -- May 11 15:00:07

Unknown entries from news log file:

First 1 / 1 lines (100.0%)

May 10 15:03:47 colo-sc-1 innd: message repeated 2 times: [ ctlinnd command s]

Log entries by program:

Program nameLines%LinesSize%Size
inn 16752 80.9%2.0 MB 78.1%
innd 2221 10.7%313.4 KB 11.9%
innfeed 1160 5.6%177.6 KB 6.8%
cnfsstat 576 2.8%85.1 KB 3.2%
nnrpd 4 0.0%0.4 KB 0.0%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 6 20714 100.0%2.6 MB100.0%

History cache:

ReasonCount%Count
Negative hits 53111 47.9%
Positive hits 41396 37.3%
Do not exist 16356 14.8%
Cache misses 21 0.0%
TOTAL: 4 110884 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:04.998 0.0%54 0.000 92.556 372.400
article cleanup00:00:00.107 0.0%16462 0.000 0.006 0.025
article logging00:00:00.871 0.0%16717 0.000 0.052 2.508
article parse00:00:00.289 0.0%31814 0.000 0.009 0.036
article write00:00:02.074 0.0%15689 0.000 0.132 3.408
artlog/artcncl00:00:00.000 0.0%54 0.000 0.000 0.000
data move00:00:00.071 0.0%122551 0.000 0.001 0.005
hisgrep/artcncl00:00:00.003 0.0%53 0.000 0.057 3.000
hishave/artcncl00:00:01.011 0.0%54 0.000 18.722 100.900
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:06:33.264 0.5%111451 0.001 3.529 23.107
history sync00:00:00.328 0.0%363 0.000 0.904 105.000
history write00:00:11.084 0.0%16462 0.000 0.673 13.824
hiswrite/artcncl00:00:00.000 0.0%1 0.000 0.000 0.000
idle23:52:36.447 99.4%119935 353.265 716.692 1993.555
nntp read00:00:00.879 0.0%121949 0.000 0.007 0.016
overview write00:00:00.054 0.0%15689 0.000 0.003 0.026
perl filter00:00:32.568 0.0%16462 0.877 1.978 13.991
python filter00:00:00.480 0.0%16462 0.000 0.029 0.091
site send00:00:02.749 0.0%47066 0.019 0.058 0.094
TOTAL: 24:00:53.19724:00:07.277 99.9%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.041 0.0%15630 0.000 0.003 0.033
article prepare00:00:00.001 0.0%605 0.000 0.002 0.091
article read00:00:00.026 0.0%524 0.000 0.050 0.500
backlog stats00:00:00.073 0.0%71413 0.000 0.001 0.016
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:00.422 0.0%48159 0.000 0.009 0.032
data write00:00:00.933 0.0%32746 0.005 0.028 0.077
idle23:57:09.345100.0%71413 636.693 1207.474 3174.714
status file00:00:04.156 0.0%216 0.000 19.241 591.500
TOTAL: 23:57:17.22923:57:14.997100.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%1 0.000 0.000 0.000
TOTAL: 00:00:00.42300: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 4 28955 7651 21168 136 26%48:54:47
2news-out.aioe.org 3 13233 5156 8045 32 38%23:52:05
3news.nntp4.net 3 17145 3098 13402 645 18%25:15:29
4localhost 1 0 0 0 0 0%00:00:00
TOTAL: 4 11 59333 15905 42615 813 26%98:02:21
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1hasname-out.news.weretis.net23.0 MB0.0 KB586.4 KB23.6 MB 97%3.1 KB
2news-out.aioe.org13.5 MB0.0 KB50.7 KB13.5 MB 99%2.7 KB
3news.nntp4.net7.1 MB0.0 KB6.3 MB13.5 MB 53%3.7 KB
4localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 443.7 MB0.0 KB6.9 MB50.6 MB 86%3.1 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
May 10 15:00:12 - 15:59:59 997 6.4% 0.282.6 MB 6.1% 0.75
May 10 16:00:00 - 16:59:59 975 6.2% 0.272.4 MB 5.6% 0.69
May 10 17:00:00 - 17:59:59 780 5.0% 0.222.2 MB 5.2% 0.63
May 10 18:00:00 - 18:59:59 826 5.3% 0.232.2 MB 5.0% 0.61
May 10 19:00:00 - 19:59:59 903 5.8% 0.252.5 MB 5.7% 0.70
May 10 20:00:00 - 20:59:59 767 4.9% 0.212.2 MB 5.0% 0.62
May 10 21:00:00 - 21:59:59 598 3.8% 0.171.5 MB 3.4% 0.42
May 10 22:00:00 - 22:59:59 462 2.9% 0.131.6 MB 3.7% 0.45
May 10 23:00:00 - 23:59:59 369 2.4% 0.101.1 MB 2.6% 0.32
May 11 00:00:00 - 00:59:59 348 2.2% 0.101.2 MB 2.8% 0.34
May 11 01:00:00 - 01:59:59 335 2.1% 0.091.0 MB 2.4% 0.29
May 11 02:00:00 - 02:59:59 295 1.9% 0.081010.5 KB 2.3% 0.28
May 11 03:00:00 - 03:59:59 275 1.8% 0.08816.8 KB 1.9% 0.23
May 11 04:00:00 - 04:59:59 346 2.2% 0.101.1 MB 2.5% 0.31
May 11 05:00:00 - 05:59:59 406 2.6% 0.11997.5 KB 2.3% 0.28
May 11 06:00:00 - 06:59:59 575 3.7% 0.161.4 MB 3.2% 0.39
May 11 07:00:00 - 07:59:59 687 4.4% 0.192.0 MB 4.7% 0.58
May 11 08:00:00 - 08:59:59 758 4.8% 0.212.1 MB 5.0% 0.61
May 11 09:00:00 - 09:59:59 861 5.5% 0.242.3 MB 5.4% 0.66
May 11 10:00:00 - 10:59:59 748 4.8% 0.212.0 MB 4.7% 0.57
May 11 11:00:00 - 11:59:59 808 5.2% 0.222.0 MB 4.7% 0.57
May 11 12:00:00 - 12:59:59 709 4.5% 0.201.9 MB 4.4% 0.54
May 11 13:00:00 - 13:59:59 876 5.6% 0.242.5 MB 5.7% 0.70
May 11 14:00:00 - 14:59:59 960 6.1% 0.272.5 MB 5.8% 0.70
May 11 15:00:00 - 15:00:07 7 0.0% 1.0026.8 KB 0.1% 3.83
TOTAL: 23:59:55 15671 100.0% 0.1843.0 MB 100.0% 0.51
Incoming articles
Incoming articles (size)

CNFS buffer status:

BufferClassSizeUsed%UsedCyclesKB/secDays
FOURDEFAULT1024.0 MB842.9 MB 82.3% 0 0.22 54.47
ONEDEFAULT1024.0 MB1001.9 MB 97.8% 2 0.22 54.70
THREEDEFAULT1024.0 MB845.0 MB 82.5% 0 0.23 53.30
TWODEFAULT1024.0 MB845.8 MB 82.6% 0 0.23 53.63
TOTAL: 4-4.0 GB3.5 GB 86.3% 2 0.22-

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1news.nntp4.net 649 18 0 0 1 0 0 0 630
2hasname-out.news.weretis.net 248 5 0 0 0 0 0 0 243
3news-out.aioe.org 130 0 0 0 0 0 0 0 130
TOTAL: 3 1027 23 0 0 1 0 0 0 1003

Unwanted newsgroups [Top 20]:

NewsgroupCount
alt.computer.hardware 15
alt.buttered.scones 3
alt.blah 2
adobe.illustrator.windows 1
man.politics 1
3dfx.test 1
TOTAL: 6 23

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

GroupsCount
bit.listserv.catholic 1
TOTAL: 1 1

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 314
EMP (phn path) 264
EMP (phn nph) 76
EMP (phl) 73
Scoring filter 11
HTML Multipart 4
User-issued spam cancel 3
Binary: misplaced binary 2
Too many newsgroups (meow) 1
TOTAL: 9 748

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
hasname-out.news.weretis.net 117
news-out.aioe.org 97
news.nntp4.net 41
TOTAL: 3 255
TOTAL: 1 255

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1bbsgslincom 499 499 0 0 0 0100%21:59:23
2aioe 10533 2 10211 1 0 1 0%23:59:54
3weretis 8347 2 8040 22 0 0 0%23:59:54
4nntp4 12883 0 12715 0 0 1 0%23:59:53
TOTAL: 4 32262 503 30966 23 0 2 1%93:59:04
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1bbsgslincom1.9 MB0.0 KB1.9 MB0.0 KB/s4.0 KB21:59:23
2weretis12.2 KB70.1 KB82.3 KB0.0 KB/s3.4 KB23:59:54
3aioe4.0 KB4.3 KB8.3 KB0.0 KB/s2.8 KB23:59:54
4nntp40.0 KB0.0 KB0.0 KB0.0 KB/s023:59:53
TOTAL: 42.0 MB74.4 KB2.0 MB0.0 KB/s4.0 KB93:59:04
Outgoing feeds (innfeed) by Volume

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
news.nntp4.net 0.001 0.002 0.00000:00:00
TOTAL: 1 0.001 0.002 0.00000:00:00

NNRP no permission clients:

SystemConn
news.nntp4.net 1
TOTAL: 1 1