Daily Usenet report for news.ripco.com

Nov 5 00:01:02 -- Nov 5 23:57:59

Unknown entries from news log file:

First 3 / 3 lines (100.0%)

Nov 5 08:38:54 remote5bge0 overchan[10664]: [ID 702911 news.error] input line too long, skipping
Nov 5 11:47:09 remote5bge0 overchan[10664]: [ID 702911 news.error] input line too long, skipping
Nov 5 12:29:20 remote5bge0 overchan[10664]: [ID 702911 news.error] input line too long, skipping

Log entries by program:

Program nameLines%LinesSize%Size
innd 25271 35.3%3.9 MB 36.8%
inn 25232 35.3%4.1 MB 39.1%
nnrpd 17382 24.3%1.8 MB 17.1%
innfeed 3630 5.1%753.2 KB 6.9%
overchan 3 0.0%0.4 KB 0.0%
controlchan 2 0.0%0.2 KB 0.0%
TOTAL: 6 71520 100.0%10.6 MB100.0%

History cache:

ReasonCount%Count
Do not exist 210040 56.1%
Cache misses 164566 43.9%
Negative hits 0 0.0%
Positive hits 0 0.0%
TOTAL: 4 374606 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.000 0.0%110 0.000 0.000 0.000
article cleanup00:00:00.432 0.0%49938 0.000 0.009 0.036
article logging00:00:00.806 0.0%50308 0.000 0.016 0.214
article parse00:00:01.854 0.0%121564 0.000 0.015 0.038
article write00:00:47.768 0.0%30042 0.403 1.590 68.585
artlog/artparse00:00:00.000 0.0%18 0.000 0.000 0.000
data move00:00:00.282 0.0%386668 0.000 0.001 0.004
hishave/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:03.312 0.0%375376 0.004 0.009 0.016
history sync00:00:00.374 0.0%790 0.000 0.473 12.000
history write00:00:04.706 0.0%49956 0.019 0.094 3.807
hiswrite/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
idle47:39:17.874 99.9%430802 232.154 398.229 925.793
nntp read00:00:02.424 0.0%430048 0.000 0.006 0.013
overview write00:00:00.196 0.0%30042 0.000 0.007 0.047
perl filter00:01:08.422 0.0%49938 1.091 1.370 2.268
python filter00:00:01.320 0.0%49948 0.004 0.026 0.078
site send00:00:01.718 0.0%90092 0.000 0.019 0.081
TOTAL: 47:42:06.40247:41:31.488100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.140 0.0%30282 0.000 0.005 0.036
article prepare00:00:00.002 0.0%10624 0.000 0.000 0.023
article read00:00:00.320 0.0%2242 0.000 0.143 71.000
backlog stats00:00:00.198 0.0%371942 0.000 0.001 0.003
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:02.200 0.0%242732 0.000 0.009 0.020
data write00:00:03.364 0.0%213272 0.003 0.016 0.032
idle47:53:01.496100.0%371942 267.785 463.463 1457.146
status file00:00:02.394 0.0%338 0.000 7.083 39.000
TOTAL: 47:53:20.36047:53:10.114100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle01:58:45.044 98.8%19446 0.333 366.402 15142.909
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:05.146 0.1%564528 0.000 0.009 0.143
readart00:00:25.688 0.4%3490 0.000 7.360 36.000
TOTAL: 02:00:13.91201:59:15.878 99.2%----

Control commands to INND:

CommandNumber
L 2
flush 2
go 4
logmode 2
mode 6
name 5
pause 2
paused 2
reserve 4
TOTAL: 9 29

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1ripco-out.feed.uzoreto.com 1150 34498 9268 20912 4318 26%94:38:30
2news.snarked.org 46 26946 8356 18132 458 31%49:31:40
3feeder3.feed-ams.uzoreto.com 574 17424 5946 9994 1484 34%47:27:54
4newsfeed.neva.ru 556 53888 5438 36448 12002 10%286:29:06
5newsfeed.fu-berlin.de 2 25232 964 24222 46 3%77:04:44
6news-in.rahul.net 574 16920 200 16700 20 1%47:18:58
7news.lightlink.com 2 10550 178 9888 484 1%49:11:52
8news.cmpublishers.com 50 8338 46 8278 14 0%48:00:02
9ripco-out.feeder.erje.net 574 31986 42 30768 1176 0%47:16:20
10localhost 156 10 10 0 0 100%00:00:00
TOTAL: 10 3684 225792 30448 175342 20002 13%746:59:06
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1ripco-out.feed.uzoreto.com25.5 MB0.0 KB10.9 MB36.4 MB 70%2.7 KB
2news.snarked.org25.1 MB0.0 KB1.7 MB26.8 MB 93%3.1 KB
3newsfeed.neva.ru15.7 MB0.0 KB49.5 MB65.2 MB 24%3.8 KB
4feeder3.feed-ams.uzoreto.com14.3 MB0.0 KB4.0 MB18.3 MB 77%2.5 KB
5news-in.rahul.net3.8 MB0.0 KB326.2 KB4.1 MB 92%19.1 KB
6newsfeed.fu-berlin.de3.3 MB0.0 KB564.9 KB3.8 MB 85%3.9 KB
7news.lightlink.com714.4 KB0.0 KB18.9 MB19.6 MB 3%30.3 KB
8news.cmpublishers.com212.9 KB0.0 KB30.2 KB243.2 KB 87%4.1 KB
9ripco-out.feeder.erje.net81.2 KB0.0 KB13.9 MB14.0 MB 0%11.8 KB
10localhost18.7 KB0.0 KB0.0 KB18.7 KB100%1.9 KB
TOTAL: 1088.6 MB0.0 KB99.8 MB188.4 MB 47%3.8 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Nov 5 00:01:02 - 00:59:59 377 2.5% 0.111.1 MB 2.5% 0.32
Nov 5 01:00:00 - 01:59:59 584 3.9% 0.161.5 MB 3.4% 0.43
Nov 5 02:00:00 - 02:59:59 541 3.6% 0.151.5 MB 3.5% 0.43
Nov 5 03:00:00 - 03:59:59 679 4.5% 0.191.7 MB 3.9% 0.48
Nov 5 04:00:00 - 04:59:59 741 4.9% 0.211.9 MB 4.3% 0.54
Nov 5 05:00:00 - 05:59:59 707 4.7% 0.201.9 MB 4.3% 0.53
Nov 5 06:00:00 - 06:59:59 722 4.8% 0.201.8 MB 4.2% 0.52
Nov 5 07:00:00 - 07:59:59 769 5.1% 0.212.2 MB 4.9% 0.62
Nov 5 08:00:00 - 08:59:59 717 4.8% 0.202.0 MB 4.5% 0.56
Nov 5 09:00:00 - 09:59:59 804 5.3% 0.222.1 MB 4.8% 0.60
Nov 5 10:00:00 - 10:59:59 849 5.6% 0.242.6 MB 5.9% 0.74
Nov 5 11:00:00 - 11:59:59 908 6.0% 0.252.5 MB 5.6% 0.70
Nov 5 12:00:00 - 12:59:59 891 5.9% 0.252.3 MB 5.3% 0.67
Nov 5 13:00:00 - 13:59:59 850 5.6% 0.242.5 MB 5.7% 0.72
Nov 5 14:00:00 - 14:59:59 759 5.0% 0.212.3 MB 5.3% 0.66
Nov 5 15:00:00 - 15:59:59 787 5.2% 0.222.8 MB 6.4% 0.80
Nov 5 16:00:00 - 16:59:59 733 4.9% 0.202.2 MB 5.1% 0.64
Nov 5 17:00:00 - 17:59:59 605 4.0% 0.171.7 MB 4.0% 0.49
Nov 5 18:00:00 - 18:59:59 386 2.6% 0.111.3 MB 2.9% 0.37
Nov 5 19:00:00 - 19:59:59 350 2.3% 0.101.1 MB 2.6% 0.32
Nov 5 20:00:00 - 20:59:59 361 2.4% 0.101.1 MB 2.6% 0.32
Nov 5 21:00:00 - 21:59:59 319 2.1% 0.091.1 MB 2.5% 0.31
Nov 5 22:00:00 - 22:59:59 264 1.8% 0.07842.3 KB 1.9% 0.23
Nov 5 23:00:00 - 23:57:59 362 2.4% 0.101.7 MB 3.9% 0.50
TOTAL: 23:56:57 15065 100.0% 0.1743.9 MB 100.0% 0.52
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1newsfeed.neva.ru 6078 2733 0 0 1 0 0 0 3344
2ripco-out.feed.uzoreto.com 2162 1275 0 0 0 0 0 0 887
3feeder3.feed-ams.uzoreto.com 746 355 0 0 0 0 0 0 391
4ripco-out.feeder.erje.net 590 517 0 0 0 0 0 0 73
5news.snarked.org 231 96 0 0 0 0 0 0 135
6news.lightlink.com 197 0 0 0 0 0 0 0 197
7newsfeed.fu-berlin.de 142 0 0 0 1 0 0 0 141
8news.cmpublishers.com 11 1 0 0 0 0 0 0 10
9news-in.rahul.net 10 0 0 0 0 0 0 0 10
TOTAL: 9 10167 4977 0 0 2 0 0 0 5188

Unwanted newsgroups [Top 20]:

NewsgroupCount
alt.binaries.boneless 2416
free.usenet 1724
alt.binaries.ftd 252
scot.general 50
alt.binaries.nl 42
fido7.su.pol.news 42
perl.cpan.uploads 30
alt.binaries.reportages.documentaires.french 27
alt.binaries.e-book 24
free.it.scienza.fisica 23
it.tlc.cellulari.android 21
alt.binaries.nospam.female.bodyhair.pubes 17
alt.binaries.pictures.rail 16
it.comp.os.win.windows10 14
alt.binaries.mac.osx.apps 12
alt.binaries.pictures.purebeauty 10
free.willey 9
alt.binaries.humor.skewed 9
alt.bestjobsusa.computer.jobs 9
alt.binaries.pictures.scenic 7
TOTAL: 138 4977

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

GroupsCount
pl.praca.oferowana 2
TOTAL: 1 2

INND Perl filter [Top 20]:

ReasonCount
Binary in non-binary group 5348
EMP (md5) 3198
Too many newsgroups 1072
EMP (phl) 144
Scoring filter (8) 144
Scoring filter (10) 22
Scoring filter (9) 22
HTML post 14
Scoring filter (12) 8
Scoring filter (16) 4
Poison newsgroup 4
Scoring filter (18) 2
Scoring filter (11) 2
Scoring filter (15) 2
TOTAL: 14 9986

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Bad Message-ID's offered
ripco-out.feeder.erje.net 18
TOTAL: 1 18
Including strange strings
newsfeed.fu-berlin.de 124
newsfeed.neva.ru 54
feeder3.feed-ams.uzoreto.com 4
news.snarked.org 2
ripco-out.feed.uzoreto.com 2
TOTAL: 5 186
No colon-space in header
feeder3.feed-ams.uzoreto.com 5
ripco-out.feeder.erje.net 2
ripco-out.feed.uzoreto.com 2
TOTAL: 3 9
TOTAL: 3 213

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1news.lightlink.com 11658 788 6700 24 0 0 6%47:40:02
2rahul.net 22200 682 13090 6 0 4 3%47:40:04
3feeder.erje.net 29574 116 28186 252 0 16 0%47:38:48
4news.snarked.org 35246 44 21246 12 0 68 0%47:33:32
5news.cmpublishers.com 45024 36 29290 546 0 56 0%47:40:02
6newsfeed.neva.ru 24860 22 24442 26 0 40 0%47:43:46
7fu-berlin.de 27610 22 27588 0 0 0 0%47:40:02
8news.uzoreto.com 14832 18 14622 16 0 0 0%47:47:58
9remote6hme0.ripco.com 0 0 0 0 0 6 0%47:40:02
TOTAL: 9 211004 1728 165164 882 0 190 0%429:04:16
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1news.lightlink.com2.6 MB147.1 KB2.8 MB0.0 KB/s3.5 KB47:40:02
2rahul.net2.6 MB21.3 KB2.6 MB0.0 KB/s3.9 KB47:40:04
3feeder.erje.net380.1 KB551.0 KB931.1 KB0.0 KB/s2.5 KB47:38:48
4news.snarked.org189.0 KB27.4 KB216.4 KB0.0 KB/s3.9 KB47:33:32
5news.cmpublishers.com148.0 KB1.4 MB1.6 MB0.0 KB/s2.8 KB47:40:02
6fu-berlin.de106.8 KB0.0 KB106.8 KB0.0 KB/s4.9 KB47:40:02
7news.uzoreto.com67.4 KB95.4 KB162.8 KB0.0 KB/s4.8 KB47:47:58
8newsfeed.neva.ru58.2 KB109.7 KB167.8 KB0.0 KB/s3.5 KB47:43:46
9remote6hme0.ripco.com0.0 KB0.0 KB0.0 KB0.0 KB/s047:40:02
TOTAL: 96.1 MB2.4 MB8.5 MB0.0 KB/s3.3 KB429:04:16
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1c-73-246-79-215.hsd1.il.comcast.net 2 10462.5 MB 8 0 000:01:12
2ftupet.com 286 10003.5 MB 488 6 000:07:41
3shell3 26 4381.2 MB 50 4 001:51:05
TOTAL: 3 314 24847.1 MB 546 10 002:00:07

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.hsd1.il.comcast.net 2 10462.5 MB 8 0 000:01:12
2*.com 286 10003.5 MB 488 6 000:07:41
3? 26 4381.2 MB 50 4 001:51:05
TOTAL: 3 314 24847.1 MB 546 10 002:00:00

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
shell3 4.804 1.914 0.00001:51:05
ftupet.com 47.076 7.936 0.00000:07:41
c-73-246-79-215.hsd1.il.comcast.net 0.386 0.134 0.00000:01:12
124-169-1-165.dyn.iinet.net.au 0.600 0.130 0.00000:00:03
59-127-214-21.hinet-ip.hinet.net 0.200 0.044 0.00000:00:02
scan-141.security.ipip.net 0.198 0.046 0.00000:00:00
worker-18.sfj.corp.censys.io 0.202 0.044 0.00000:00:00
census9.shodan.io 0.200 0.044 0.00000:00:00
TOTAL: 8 53.666 10.292 0.00002:00:07

NNRP no permission clients:

SystemConn
124-169-1-165.dyn.iinet.net.au 6
scan-141.security.ipip.net 2
59-127-214-21.hinet-ip.hinet.net 2
census9.shodan.io 2
worker-18.sfj.corp.censys.io 2
TOTAL: 5 14

NNRP unrecognized commands (by host):

SystemConn
shell3 8
TOTAL: 1 8

NNRP unrecognized commands (by command):

CommandCount
XTHREAD DBINIT 8
TOTAL: 1 8

NNRP client timeouts [Top 20]:

SystemConnPeer
shell3 2 0
TOTAL: 1 2 0

Newsgroup request counts (by category):

CategoryCountPct
1rec 1204 48.5%
2misc 670 27.0%
3sci 464 18.7%
4comp 58 2.3%
5news 48 1.9%
6alt 30 1.2%
7chi 8 0.3%
8ba 2 0.1%
TOTAL: 8 2484100.0%

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

NewsgroupCount
1misc.phone.mobile.iphone 608
2rec.arts.tv 574
3sci.electronics.repair 464
4rec.food.cooking 360
5rec.bicycles.tech 238
6misc.consumers.frugal-living 62
7news.software.nntp 36
8comp.protocols.dns.bind 18
9comp.mobile.ipad 16
10alt.stupidity 16
11rec.audio.high-end 12
12rec.antiques.radio+phono 12
13comp.unix.solaris 8
14alt.free.newsservers 8
15comp.sys.mac.system 8
16news.admin.net-abuse.email 6
17alt.internet.wireless 6
18rec.radio.broadcasting 4
19comp.sys.mac.vintage 4
20chi.forsale 4
21rec.radio.swap 4
22chi.weather 4
23ba.internet 2
24comp.sys.mac.apps 2
25comp.mobile.android 2
26news.groups 2
27news.lists.misc 2
28news.groups.questions 2
TOTAL: 28 2484