Daily Usenet report

Sep 15 15:00:02 -- Sep 16 15:00:24

Unknown entries from news log file:

First 1 / 1 lines (100.0%)

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

Log entries by program:

Program nameLines%LinesSize%Size
inn 15371 76.6%1.8 MB 74.0%
innd 2874 14.3%403.9 KB 15.8%
innfeed 1247 6.2%177.9 KB 7.0%
cnfsstat 576 2.9%83.1 KB 3.3%
nnrpd 8 0.0%0.9 KB 0.0%
controlchan 1 0.0%0.1 KB 0.0%
TOTAL: 6 20077 100.0%2.5 MB100.0%

History cache:

ReasonCount%Count
Positive hits 39587 42.2%
Negative hits 39173 41.8%
Do not exist 14980 16.0%
Cache misses 27 0.0%
TOTAL: 4 93767 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:01.993 0.0%73 0.000 27.301 179.000
article cleanup00:00:00.112 0.0%15089 0.000 0.007 0.054
article logging00:00:00.473 0.0%15313 0.000 0.031 0.105
article parse00:00:00.269 0.0%28593 0.000 0.009 0.028
article write00:00:02.046 0.0%13665 0.000 0.150 4.879
artlog/artcncl00:00:00.000 0.0%71 0.000 0.000 0.000
data move00:00:00.078 0.0%105819 0.000 0.001 0.004
hisgrep/artcncl00:00:00.007 0.0%72 0.000 0.097 0.625
hishave/artcncl00:00:00.440 0.0%73 0.000 6.027 45.889
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:01:59.435 0.1%94362 0.000 1.266 46.750
history sync00:00:00.305 0.0%368 0.000 0.829 143.000
history write00:00:02.967 0.0%15089 0.000 0.197 16.734
hiswrite/artcncl00:00:00.000 0.0%1 0.000 0.000 0.000
idle23:58:00.556 99.8%105144 377.648 820.594 2459.270
nntp read00:00:00.876 0.0%105448 0.000 0.008 0.019
overview write00:00:00.063 0.0%13665 0.000 0.005 0.024
perl filter00:00:25.041 0.0%15089 0.863 1.660 53.248
python filter00:00:00.440 0.0%15089 0.000 0.029 0.077
site send00:00:02.443 0.0%40995 0.023 0.060 0.130
TOTAL: 24:00:59.11124:00:37.544100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.019 0.0%13623 0.000 0.001 0.029
article prepare00:00:00.000 0.0%667 0.000 0.000 0.000
article read00:00:00.022 0.0%437 0.000 0.050 1.000
backlog stats00:00:00.062 0.0%80559 0.000 0.001 0.010
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:00.372 0.0%48072 0.000 0.008 0.029
data write00:00:01.025 0.0%34611 0.000 0.030 0.090
idle23:57:42.208100.0%80559 632.124 1070.795 2533.511
status file00:00:00.983 0.0%265 0.000 3.709 811.000
TOTAL: 23:57:46.73823:57:44.691100.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%2 0.000 0.000 0.000
TOTAL: 00:00:03.51500:00:00.000 0.0%----

Control commands to INND:

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

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1hasname-out.news.weretis.net 4 26159 8636 17042 481 33%47:42:23
2news-out.aioe.org 4 13705 4613 9092 0 33%24:30:20
3news.nntp4.net 1 14096 351 12826 919 2%22:55:28
4localhost 1 0 0 0 0 0%00:00:00
TOTAL: 4 10 53960 13600 38960 1400 25%95:08:11
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1hasname-out.news.weretis.net28.2 MB0.0 KB968.5 KB29.2 MB 96%3.3 KB
2news-out.aioe.org11.7 MB0.0 KB0.0 KB11.7 MB100%2.6 KB
3news.nntp4.net1.2 MB0.0 KB5.9 MB7.1 MB 16%5.7 KB
4localhost0.0 KB0.0 KB0.0 KB0.0 KB 0%0
TOTAL: 441.1 MB0.0 KB6.9 MB48.0 MB 85%3.3 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Sep 15 15:00:02 - 15:59:59 882 6.5% 0.252.4 MB 5.9% 0.70
Sep 15 16:00:00 - 16:59:59 760 5.6% 0.212.1 MB 5.1% 0.60
Sep 15 17:00:00 - 17:59:59 717 5.2% 0.202.0 MB 4.8% 0.56
Sep 15 18:00:00 - 18:59:59 696 5.1% 0.191.9 MB 4.7% 0.55
Sep 15 19:00:00 - 19:59:59 688 5.0% 0.191.8 MB 4.3% 0.50
Sep 15 20:00:00 - 20:59:59 693 5.1% 0.191.9 MB 4.7% 0.55
Sep 15 21:00:00 - 21:59:59 684 5.0% 0.192.0 MB 4.9% 0.57
Sep 15 22:00:00 - 22:59:59 560 4.1% 0.161.9 MB 4.7% 0.55
Sep 15 23:00:00 - 23:59:59 436 3.2% 0.121.4 MB 3.4% 0.40
Sep 16 00:00:00 - 00:59:59 329 2.4% 0.091.6 MB 3.9% 0.46
Sep 16 01:00:00 - 01:59:59 263 1.9% 0.07887.2 KB 2.1% 0.25
Sep 16 02:00:00 - 02:59:59 291 2.1% 0.081.2 MB 3.0% 0.35
Sep 16 03:00:00 - 03:59:59 252 1.8% 0.071.0 MB 2.5% 0.29
Sep 16 04:00:00 - 04:59:59 270 2.0% 0.07937.5 KB 2.2% 0.26
Sep 16 05:00:00 - 05:59:59 311 2.3% 0.091.1 MB 2.7% 0.31
Sep 16 06:00:00 - 06:59:59 471 3.4% 0.131.7 MB 4.2% 0.49
Sep 16 07:00:00 - 07:59:59 609 4.5% 0.171.7 MB 4.1% 0.48
Sep 16 08:00:00 - 08:59:59 665 4.9% 0.182.0 MB 4.8% 0.56
Sep 16 09:00:00 - 09:59:59 635 4.6% 0.182.1 MB 5.1% 0.60
Sep 16 10:00:00 - 10:59:59 596 4.4% 0.171.7 MB 4.0% 0.47
Sep 16 11:00:00 - 11:59:59 723 5.3% 0.202.1 MB 5.0% 0.58
Sep 16 12:00:00 - 12:59:59 602 4.4% 0.171.8 MB 4.2% 0.50
Sep 16 13:00:00 - 13:59:59 735 5.4% 0.202.0 MB 4.9% 0.57
Sep 16 14:00:00 - 14:59:59 776 5.7% 0.221.9 MB 4.7% 0.55
Sep 16 15:00:00 - 15:00:24 15 0.1% 0.6262.8 KB 0.1% 2.62
TOTAL: 24:00:22 13659 100.0% 0.1641.3 MB 100.0% 0.49
Incoming articles
Incoming articles (size)

CNFS buffer status:

BufferClassSizeUsed%UsedCyclesKB/secDays
FOURDEFAULT1024.0 MB1016.2 MB 99.2% 2 0.21 58.85
ONEDEFAULT1024.0 MB154.5 MB 15.1% 5 0.20 59.57
THREEDEFAULT1024.0 MB1020.0 MB 99.6% 2 0.20 59.23
TWODEFAULT1024.0 MB1015.3 MB 99.1% 2 0.20 60.07
TOTAL: 4-4.0 GB3.1 GB 78.3% 11 0.20-

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1news.nntp4.net 944 0 0 0 1 0 0 0 943
2hasname-out.news.weretis.net 628 9 0 0 0 0 0 0 619
3news-out.aioe.org 69 0 0 0 0 0 0 0 69
TOTAL: 3 1641 9 0 0 1 0 0 0 1631

Unwanted newsgroups [Top 20]:

NewsgroupCount
alt.math 3
alt.bestjobsusa.florida.jobs 2
alt.biz.misc 1
alt.business.business 1
gnu.bash 1
mailing.unix.amavis-user 1
TOTAL: 6 9

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) 870
EMP (md5) 325
EMP (phn nph) 170
User-issued spam cancel 16
Binary: misplaced binary 12
EMP (phl) 12
HTML Multipart 1
HTML post 1
TOTAL: 8 1407

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Including strange strings
hasname-out.news.weretis.net 153
news-out.aioe.org 69
news.nntp4.net 2
TOTAL: 3 224
TOTAL: 1 224

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1bbsgslincom 361 360 0 1 0 0 99%19:08:25
2aioe 12136 37 9016 0 0 0 0%24:00:00
3nntp4 16357 5 13259 0 0 5 0%23:58:14
4weretis 5302 0 4778 34 0 0 0%24:00:00
TOTAL: 4 34156 402 27053 35 0 5 1%91:06:39
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1bbsgslincom1.3 MB0.0 KB1.3 MB0.0 KB/s3.7 KB19:08:25
2aioe149.8 KB0.0 KB149.8 KB0.0 KB/s4.0 KB24:00:00
3nntp412.5 KB0.0 KB12.5 KB0.0 KB/s2.5 KB23:58:14
4weretis0.0 KB143.9 KB143.9 KB0.0 KB/s4.2 KB24:00:00
TOTAL: 41.5 MB143.9 KB1.6 MB0.0 KB/s3.7 KB91:06:39
Outgoing feeds (innfeed) by Volume

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
scanner-27.ch1.censys-scanner.com 0.002 0.003 0.00000:00:03
news.nntp4.net 0.000 0.004 0.00000:00:00
TOTAL: 2 0.002 0.007 0.00000:00:03

NNRP no permission clients:

SystemConn
news.nntp4.net 1
scanner-27.ch1.censys-scanner.com 1
TOTAL: 2 2