Hi,

I made the benchmarks with the files you provided. I have more or less the
same magnitude:
Version 504: 0:00:01:09.021
Version 1175: 0:00:02:37.507

However, by launching it in the time profiler (MooseModel new
importFromMSEStream: (StandardFileStream readOnlyFileNamed:
'd:/ArgoUML-0-34.mse')), it takes
504: 1 min 55
1175: 4 min 25
Well there is a delta...

After investigation, the standard process has almost the same duration (120
secs for prespur and 140 secs for spur).
But, there is a large difference in GC time:

504: not spur
**Memory**
        old                     +144,822,000 bytes
        young           -8,293,660 bytes
        used            +136,528,340 bytes
        free            -104,186,788 bytes

**GCs**
        full                    1 totalling 965ms (1.0% uptime), avg 965.0ms
        incr            3264 totalling 42,279ms (33.0% uptime), avg 13.0ms
        tenures         2,497 (avg 1 GCs/tenure)
        root table      0 overflows

1175: spur
**Memory**
        old                     +0 bytes
        young           +340,048 bytes
        used            +340,048 bytes
        free            -340,048 bytes
**GCs**
        full                    7 totalling 145,003ms (66.0% uptime), avg
20715.0ms
        incr            3288 totalling 30,912ms (14.0% uptime), avg 9.0ms
        tenures         7,146,505 (avg 0 GCs/tenure)
        root table      0 overflows

Total GC time
504: 43 secs
1175: 176 secs

See the performance reports attached.

I let VM people take care of the issue ;)

Cheers, 
Vincent

-----Original Message-----
From: [email protected]
[mailto:[email protected]] On Behalf Of Tudor Girba
Sent: dimanche 24 janvier 2016 09:08
To: Moose-related development
Subject: [Moose-dev] Re: mse loading looks slower :(

Hi,

I am talking about the difference between Moose 6 images:
- October 7:
https://ci.inria.fr/moose/job/moose-6.0/504/artifact/moose-6.0.zip

- yesterday:
https://ci.inria.fr/moose/job/moose-6.0/1175/artifact/moose-6.0.zip

Multiple things did change, but not in Moose. In the end, I would like to
understand where the slowness comes. Maybe it comes from Spur itself, but
maybe it comes from somewhere else.

Cheers,
Doru



> On Jan 24, 2016, at 1:41 AM, Mariano Martinez Peck <[email protected]>
wrote:
> 
> Doru...just to be sure it is not a Pharo (image change), when you said
before and after Spur, do you mean a Pharo 5.0 exactly (just before Spur)
and a Pharo JUST after it?  Otherwise, the slowness may come from the
difference between the 2 Pharos you are running.
> 
> Cheers,
> 
> On Sat, Jan 23, 2016 at 5:55 PM, Tudor Girba <[email protected]> wrote:
> Hi,
> 
> I am doing some performance testing of Moose with the Spur VM on Mac.
> 
> I tried to load an MSE file with ArgoUML 0.34 and on my machine it loads
twice as slow with Spur than before:
> - PreSpur: 0:00:01:07.272
> - Spur: 0:00:02:10.508
> 
> Here is the reference file:
> https://dl.dropboxusercontent.com/u/18323746/Tmp/ArgoUML-0-34.mse.zip
> 
> And here is the script:
> [
>         MooseModel new
>                 importFromMSEStream: (StandardFileStream
readOnlyFileNamed:
>                         (FileSystem workingDirectory / 'src' /
'ArgoUML-0-34' / 'ArgoUML-0-34.mse') fullName).
>         ] timeToRun
> 
> Do you get the same?
> 
> Cheers,
> Doru
> 
> 
> --
> www.tudorgirba.com
> www.feenk.com
> 
> "Problem solving should be focused on describing the problem in a way 
> that makes the solution obvious."
> 
> 
> 
> 
> 
> _______________________________________________
> Moose-dev mailing list
> [email protected]
> https://www.list.inf.unibe.ch/listinfo/moose-dev
> 
> 
> 
> --
> Mariano
> http://marianopeck.wordpress.com
> _______________________________________________
> Moose-dev mailing list
> [email protected]
> https://www.list.inf.unibe.ch/listinfo/moose-dev

--
www.tudorgirba.com
www.feenk.com

"What is more important: To be happy, or to make happy?"

_______________________________________________
Moose-dev mailing list
[email protected]
https://www.list.inf.unibe.ch/listinfo/moose-dev
 - 128030 tallies, 129019 msec.

**Tree**
--------------------------------
Process: (40s) Morphic UI Process: nil
--------------------------------
96.0% {123915ms} MooseModel class>>importFrom:
  |96.0% {123915ms} MooseModel class>>importFrom:withMetamodel:
  |  96.0% {123908ms} MSEImporter(FMImporter)>>run
  |    96.0% {123908ms} FMMSEParser>>run
  |      96.0% {123904ms} FMMSEParser>>basicRun
  |        96.0% {123904ms} FMMSEParser>>Document
  |          87.2% {112446ms} FMMSEParser>>Element
  |            |64.1% {82656ms} FMMSEParser>>Attribute
  |            |  |22.2% {28673ms} FMMSEParser>>Value
  |            |  |  |10.2% {13160ms} FMMSEParser>>Reference
  |            |  |  |  |5.0% {6512ms} FMMSEParser>>Identifier
  |            |  |  |  |  |3.4% {4344ms} Character>>isDigit
  |            |  |  |  |  |  3.0% {3857ms} Character>>characterSet
  |            |  |  |  |  |    2.9% {3798ms} EncodedCharSet class>>charsetAt:
  |            |  |  |  |  |      2.9% {3722ms} 
Array(SequenceableCollection)>>at:ifAbsent:
  |            |  |  |  |  |        2.8% {3616ms} primitives
  |            |  |  |  |1.8% {2328ms} MSEImporter(FMImporter)>>referenceNumber:
  |            |  |  |  |  |1.8% {2308ms} FMFutureAttribute>>referenceNumber:
  |            |  |  |  |1.8% {2313ms} FMMSEParser>>tOPEN
  |            |  |  |  |  |1.7% {2256ms} primitives
  |            |  |  |  |1.1% {1390ms} FMMSEParser>>backtrack:
  |            |  |  |  |  1.1% {1371ms} SmallInteger(ProtoObject)>>~~
  |            |  |  |7.6% {9825ms} FMMSEParser>>Primitive
  |            |  |  |  |6.4% {8252ms} FMMSEParser>>Number
  |            |  |  |  |  2.4% {3055ms} WriteStream>>reset
  |            |  |  |  |    |2.4% {3051ms} primitives
  |            |  |  |  |  2.0% {2569ms} FMMSEParser>>backtrack:
  |            |  |  |  |    |1.8% {2287ms} SmallInteger(ProtoObject)>>~~
  |            |  |  |  |  1.7% {2254ms} Character>>isDigit
  |            |  |  |  |    1.5% {1975ms} Character>>characterSet
  |            |  |  |  |      1.5% {1945ms} EncodedCharSet class>>charsetAt:
  |            |  |  |  |        1.5% {1925ms} 
Array(SequenceableCollection)>>at:ifAbsent:
  |            |  |  |  |          1.4% {1833ms} primitives
  |            |  |  |2.2% {2880ms} FMMSEParser>>Element
  |            |  |  |  |1.2% {1490ms} FMMSEParser>>tOPEN
  |            |  |  |  |1.0% {1332ms} FMMSEParser>>backtrack:
  |            |  |  |  |  1.0% {1311ms} SmallInteger(ProtoObject)>>~~
  |            |  |  |2.1% {2734ms} FMMSEParser>>Reference2
  |            |  |  |  1.1% {1383ms} FMMSEParser>>backtrack:
  |            |  |  |    |1.1% {1363ms} SmallInteger(ProtoObject)>>~~
  |            |  |  |  1.0% {1307ms} FMMSEParser>>tOPEN
  |            |  |22.1% {28563ms} MSEImporter(FMImporter)>>endAttribute:
  |            |  |  |22.1% {28474ms} FMFutureElement>>endAttribute:
  |            |  |  |  22.0% {28409ms} FMFutureAttribute>>endAttribute:
  |            |  |  |    22.0% {28359ms} FMFutureAttribute>>maybeEnd
  |            |  |  |      13.1% {16892ms} 
FM3PropertyDescription>>setOn:values:
  |            |  |  |        |12.8% {16473ms} 
FAMIXMethod(Object)>>mmSetProperty:to:
  |            |  |  |        |  12.7% {16354ms} 
FM3PropertyDescription>>setOn:rawValue:
  |            |  |  |        |    3.0% {3830ms} 
FAMIXLocalVariable(FAMIXStructuralEntity)>>declaredType:
  |            |  |  |        |      |3.0% {3816ms} FMMultivalueLink 
class>>on:update:from:to:
  |            |  |  |        |      |  3.0% {3808ms} 
FMMultivalueLink>>unsafeAdd:
  |            |  |  |        |      |    2.9% {3788ms} 
OrderedCollection(SequenceableCollection)>>includes:
  |            |  |  |        |      |      2.9% {3788ms} 
OrderedCollection(SequenceableCollection)>>indexOf:
  |            |  |  |        |      |        2.9% {3788ms} 
OrderedCollection(SequenceableCollection)>>indexOf:ifAbsent:
  |            |  |  |        |      |          2.9% {3788ms} 
OrderedCollection(SequenceableCollection)>>indexOf:startingAt:ifAbsent:
  |            |  |  |        |      |            2.7% {3484ms} primitives
  |            |  |  |        |    2.9% {3787ms} 
FAMIXMethod(FAMIXBehaviouralEntity)>>declaredType:
  |            |  |  |        |      |2.9% {3773ms} FMMultivalueLink 
class>>on:update:from:to:
  |            |  |  |        |      |  2.9% {3769ms} 
FMMultivalueLink>>unsafeAdd:
  |            |  |  |        |      |    2.9% {3765ms} 
OrderedCollection(SequenceableCollection)>>includes:
  |            |  |  |        |      |      2.9% {3765ms} 
OrderedCollection(SequenceableCollection)>>indexOf:
  |            |  |  |        |      |        2.9% {3765ms} 
OrderedCollection(SequenceableCollection)>>indexOf:ifAbsent:
  |            |  |  |        |      |          2.9% {3765ms} 
OrderedCollection(SequenceableCollection)>>indexOf:startingAt:ifAbsent:
  |            |  |  |        |      |            2.7% {3537ms} primitives
  |            |  |  |        |    2.8% {3669ms} FAMIXInvocation>>receiver:
  |            |  |  |        |      |2.8% {3645ms} FMMultivalueLink 
class>>on:update:from:to:
  |            |  |  |        |      |  2.8% {3562ms} 
FMMultivalueLink>>unsafeAdd:
  |            |  |  |        |      |    2.7% {3538ms} 
OrderedCollection(SequenceableCollection)>>includes:
  |            |  |  |        |      |      2.7% {3536ms} 
OrderedCollection(SequenceableCollection)>>indexOf:
  |            |  |  |        |      |        2.7% {3536ms} 
OrderedCollection(SequenceableCollection)>>indexOf:ifAbsent:
  |            |  |  |        |      |          2.7% {3536ms} 
OrderedCollection(SequenceableCollection)>>indexOf:startingAt:ifAbsent:
  |            |  |  |        |      |            2.6% {3302ms} primitives
  |            |  |  |        |    2.1% {2700ms} ByteSymbol(Symbol)>>asMutator
  |            |  |  |        |      2.0% {2587ms} ByteString(String)>>asSymbol
  |            |  |  |        |        1.8% {2330ms} Symbol class>>intern:
  |            |  |  |        |          1.8% {2293ms} Symbol class>>lookup:
  |            |  |  |        |            1.8% {2291ms} WeakSet>>like:
  |            |  |  |        |              1.7% {2252ms} WeakSet>>scanFor:
  |            |  |  |        |                1.2% {1542ms} 
ByteString(String)>>hash
  |            |  |  |        |                  1.2% {1498ms} ByteString 
class(Object)>>hash
  |            |  |  |        |                    1.1% {1458ms} primitives
  |            |  |  |      8.7% {11168ms} 
FM3MetaDescription>>attributeNamed:ifAbsent:
  |            |  |  |        4.1% {5354ms} 
FM3MetaDescription>>attributeNamed:ifAbsent:
  |            |  |  |          |1.7% {2146ms} 
FM3MetaDescription>>attributeNamed:ifAbsent:
  |            |  |  |          |  |1.0% {1343ms} 
FM3MetaDescription>>attributeNamed:ifAbsent:
  |            |  |  |          |1.3% {1635ms} 
FMMultivalueLink(Collection)>>detect:ifNone:
  |            |  |  |        2.4% {3033ms} 
FMMultivalueLink(Collection)>>detect:ifNone:
  |            |  |  |          |1.7% {2203ms} 
FMMultivalueLink(Collection)>>detect:ifFound:ifNone:
  |            |  |  |        1.3% {1703ms} ByteString(String)>>=
  |            |  |  |          1.3% {1668ms} primitives
  |            |  |11.3% {14615ms} FMMSEParser>>tNAME
  |            |  |  |8.2% {10602ms} Character>>isAlphaNumeric
  |            |  |  |  |6.7% {8599ms} Character>>isLetter
  |            |  |  |  |  |6.1% {7891ms} Character>>characterSet
  |            |  |  |  |  |  6.0% {7800ms} EncodedCharSet class>>charsetAt:
  |            |  |  |  |  |    5.9% {7670ms} 
Array(SequenceableCollection)>>at:ifAbsent:
  |            |  |  |  |  |      5.8% {7446ms} primitives
  |            |  |  |  |1.1% {1460ms} Character>>isDigit
  |            |  |  |1.0% {1346ms} Character>>isLetter
  |            |  |5.2% {6768ms} MSEImporter(FMImporter)>>beginAttribute:
  |            |  |  |5.2% {6688ms} FMFutureElement>>beginAttribute:
  |            |  |  |  4.3% {5487ms} PhexMatcher>>beTrue
  |            |  |  |    4.0% {5171ms} PhexMatcher>>true
  |            |  |  |      3.7% {4744ms} 
PhexMatcher>>expectedUnknownMessageToReturn:
  |            |  |  |        2.2% {2860ms} Array(Collection)>>copyWithout:
  |            |  |  |          |2.2% {2791ms} 
Array(SequenceableCollection)>>reject:
  |            |  |  |          |  1.4% {1769ms} Array 
class(SequenceableCollection class)>>new:streamContents:
  |            |  |  |        1.4% {1785ms} 
PhexMatcher>>expect:describeShould:describeShouldNot:
  |            |  |  |          1.2% {1567ms} primitives
  |            |  |1.8% {2319ms} FMMSEParser>>tOPEN
  |            |  |  1.7% {2218ms} primitives
  |            |13.7% {17639ms} FMMSEParser>>Serial
  |            |  |11.0% {14200ms} MSEImporter(FMImporter)>>serial:
  |            |  |  |11.0% {14171ms} FMFutureElement>>serial:
  |            |  |  |  11.0% {14163ms} MSEImporter(FMImporter)>>assign:to:
  |            |  |  |    9.3% {12016ms} FMDanglingReference>>resolve:
  |            |  |  |      7.4% {9603ms} FMFutureAttribute>>maybeEnd
  |            |  |  |        |4.3% {5485ms} 
FM3PropertyDescription>>setOn:values:
  |            |  |  |        |  |4.1% {5309ms} 
FAMIXParameter(Object)>>mmSetProperty:to:
  |            |  |  |        |  |  4.1% {5289ms} 
FM3PropertyDescription>>setOn:rawValue:
  |            |  |  |        |  |    1.9% {2392ms} 
FAMIXParameter(FAMIXStructuralEntity)>>declaredType:
  |            |  |  |        |  |      1.8% {2372ms} FMMultivalueLink 
class>>on:update:from:to:
  |            |  |  |        |  |        1.8% {2340ms} 
FMMultivalueLink>>unsafeAdd:
  |            |  |  |        |  |          1.8% {2332ms} 
OrderedCollection(SequenceableCollection)>>includes:
  |            |  |  |        |  |            1.8% {2332ms} 
OrderedCollection(SequenceableCollection)>>indexOf:
  |            |  |  |        |  |              1.8% {2332ms} 
OrderedCollection(SequenceableCollection)>>indexOf:ifAbsent:
  |            |  |  |        |  |                1.8% {2332ms} 
OrderedCollection(SequenceableCollection)>>indexOf:startingAt:ifAbsent:
  |            |  |  |        |  |                  1.6% {2096ms} primitives
  |            |  |  |        |3.1% {4027ms} 
FM3MetaDescription>>attributeNamed:ifAbsent:
  |            |  |  |        |  1.2% {1573ms} 
FM3MetaDescription>>attributeNamed:ifAbsent:
  |            |  |  |      1.8% {2296ms} PhexMatcher>>beTrue
  |            |  |  |        1.7% {2248ms} PhexMatcher>>true
  |            |  |  |          1.7% {2148ms} 
PhexMatcher>>expectedUnknownMessageToReturn:
  |            |  |  |            1.2% {1581ms} Array(Collection)>>copyWithout:
  |            |  |  |              1.1% {1461ms} 
Array(SequenceableCollection)>>reject:
  |            |  |2.1% {2653ms} FMMSEParser>>Identifier
  |            |  |  1.4% {1803ms} Character>>isDigit
  |            |  |    1.3% {1624ms} Character>>characterSet
  |            |  |      1.2% {1589ms} EncodedCharSet class>>charsetAt:
  |            |  |        1.2% {1572ms} 
Array(SequenceableCollection)>>at:ifAbsent:
  |            |  |          1.2% {1532ms} primitives
  |            |4.2% {5366ms} FMMSEParser>>tFULLNAME
  |            |  |3.0% {3884ms} Character>>isAlphaNumeric
  |            |  |  2.5% {3244ms} Character>>isLetter
  |            |  |    2.3% {2904ms} Character>>characterSet
  |            |  |      2.2% {2866ms} EncodedCharSet class>>charsetAt:
  |            |  |        2.2% {2829ms} 
Array(SequenceableCollection)>>at:ifAbsent:
  |            |  |          2.1% {2747ms} primitives
  |            |4.1% {5272ms} MSEImporter(FMImporter)>>beginElement:
  |            |  4.0% {5098ms} FMFutureElement class>>with:name:
  |            |    3.9% {5089ms} FMFutureElement>>with:name:
  |            |      3.5% {4541ms} FM3MetaDescription>>createInstance
  |            |        3.4% {4433ms} FAMIXMethod class(Behavior)>>new
  |            |          1.3% {1678ms} FAMIXMethod>>initialize
  |            |            1.3% {1659ms} 
FAMIXMethod(FAMIXBehaviouralEntity)>>initialize
  |          8.9% {11449ms} MSEImporter>>endDocument
  |            8.9% {11449ms} FMRepository>>addAll:
  |              8.8% {11399ms} FMRepository>>add:
  |                8.8% {11393ms} IdentitySet(Set)>>add:
  |                  8.3% {10772ms} IdentitySet>>scanFor:
  |                    8.3% {10743ms} primitives
3.1% {4004ms} MooseModel>>silentlyAddAll:
  3.0% {3817ms} MooseModel>>silentlyAdd:
    1.8% {2353ms} MooseModel>>add:
      1.4% {1857ms} MooseModel(MooseAbstractGroup)>>add:
        1.4% {1815ms} MooseGroupRuntimeStorage>>add:
          1.4% {1758ms} MooseGroupRuntimeStorage>>updateCacheFor:

**Leaves**
16.5% {21271ms} Array(SequenceableCollection)>>at:ifAbsent:
10.5% {13599ms} Array(SequenceableCollection)>>indexOf:startingAt:ifAbsent:
8.6% {11115ms} IdentitySet>>scanFor:
6.3% {8071ms} FMMSEParser>>tOPEN
5.8% {7508ms} False(ProtoObject)>>~~
3.5% {4500ms} ByteString(String)>>=
3.1% {4050ms} WriteStream>>reset
2.1% {2659ms} WriteStream>>nextPut:
2.0% {2547ms} PhexMatcher>>expect:describeShould:describeShouldNot:
1.9% {2466ms} FMMultivalueLink(Collection)>>detect:ifFound:ifNone:
1.8% {2336ms} FMMultivalueLink(Collection)>>detect:ifNone:
1.7% {2204ms} FMMultivalueLink>>do:
1.4% {1780ms} FM3MetaDescription>>attributeNamed:ifAbsent:
1.2% {1505ms} ByteString class(Object)>>hash
1.1% {1482ms} Array class(SequenceableCollection class)>>new:streamContents:
1.1% {1471ms} FMMSEParser>>tWHITESPACE
1.1% {1366ms} Array(SequenceableCollection)>>reject:

**Memory**
        old                     +144,822,000 bytes
        young           -8,293,660 bytes
        used            +136,528,340 bytes
        free            -104,186,788 bytes

**GCs**
        full                    1 totalling 965ms (1.0% uptime), avg 965.0ms
        incr            3264 totalling 42,279ms (33.0% uptime), avg 13.0ms
        tenures         2,497 (avg 1 GCs/tenure)
        root table      0 overflows
 - 218927 tallies, 219329 msec.

**Tree**
--------------------------------
Process: (40s) Morphic UI Process: nil
--------------------------------
66.0% {144772ms} MooseModel class>>importFrom:
  |66.0% {144772ms} MooseModel class>>importFrom:withMetamodel:
  |  66.0% {144767ms} MSEImporter(FMImporter)>>run
  |    66.0% {144767ms} FMMSEParser>>run
  |      66.0% {144765ms} FMMSEParser>>basicRun
  |        66.0% {144765ms} FMMSEParser>>Document
  |          65.9% {144527ms} FMMSEParser>>Element
  |            56.9% {124894ms} FMMSEParser>>Attribute
  |              |36.0% {78884ms} FMMSEParser>>tNAME
  |              |  |35.1% {76974ms} Character>>isAlphaNumeric
  |              |  |  34.7% {76101ms} Character>>isLetter
  |              |  |    34.5% {75573ms} Character>>characterSet
  |              |  |      34.4% {75460ms} EncodedCharSet class>>charsetAt:
  |              |  |        34.4% {75373ms} 
Array(SequenceableCollection)>>at:ifAbsent:
  |              |  |          34.3% {75276ms} primitives
  |              |9.8% {21561ms} FMMSEParser>>Value
  |              |  |5.1% {11141ms} FMMSEParser>>Reference
  |              |  |  |3.2% {7119ms} FMMSEParser>>Identifier
  |              |  |  |  2.6% {5746ms} Character>>isDigit
  |              |  |  |    2.5% {5425ms} Character>>characterSet
  |              |  |  |      2.5% {5379ms} EncodedCharSet class>>charsetAt:
  |              |  |  |        2.4% {5331ms} 
Array(SequenceableCollection)>>at:ifAbsent:
  |              |  |  |          2.4% {5286ms} primitives
  |              |  |3.2% {7047ms} FMMSEParser>>Primitive
  |              |  |  2.9% {6433ms} FMMSEParser>>Number
  |              |  |    1.4% {3108ms} Character>>isDigit
  |              |  |      1.3% {2936ms} Character>>characterSet
  |              |  |        1.3% {2922ms} EncodedCharSet class>>charsetAt:
  |              |  |          1.3% {2893ms} 
Array(SequenceableCollection)>>at:ifAbsent:
  |              |  |            1.3% {2877ms} primitives
  |              |8.1% {17804ms} MSEImporter(FMImporter)>>endAttribute:
  |              |  |8.1% {17723ms} FMFutureElement>>endAttribute:
  |              |  |  8.1% {17698ms} FMFutureAttribute>>endAttribute:
  |              |  |    8.1% {17660ms} FMFutureAttribute>>maybeEnd
  |              |  |      4.5% {9934ms} FM3PropertyDescription>>setOn:values:
  |              |  |        |4.4% {9620ms} 
FAMIXFileAnchor(Object)>>mmSetProperty:to:
  |              |  |        |  4.4% {9546ms} 
FM3PropertyDescription>>setOn:rawValue:
  |              |  |        |    1.4% {3007ms} 
FAMIXLocalVariable(FAMIXStructuralEntity)>>declaredType:
  |              |  |        |      |1.4% {3000ms} FMMultivalueLink 
class>>on:update:from:to:
  |              |  |        |      |  1.4% {2981ms} 
FMMultivalueLink>>unsafeAdd:
  |              |  |        |      |    1.4% {2963ms} 
OrderedCollection(SequenceableCollection)>>includes:
  |              |  |        |      |      1.4% {2961ms} 
OrderedCollection(SequenceableCollection)>>indexOf:
  |              |  |        |      |        1.4% {2961ms} 
OrderedCollection(SequenceableCollection)>>indexOf:ifAbsent:
  |              |  |        |      |          1.4% {2961ms} 
OrderedCollection(SequenceableCollection)>>indexOf:startingAt:ifAbsent:
  |              |  |        |      |            1.2% {2740ms} primitives
  |              |  |        |    1.0% {2240ms} 
FAMIXMethod(FAMIXBehaviouralEntity)>>declaredType:
  |              |  |        |      1.0% {2238ms} FMMultivalueLink 
class>>on:update:from:to:
  |              |  |        |        1.0% {2234ms} FMMultivalueLink>>unsafeAdd:
  |              |  |        |          1.0% {2221ms} 
OrderedCollection(SequenceableCollection)>>includes:
  |              |  |        |            1.0% {2219ms} 
OrderedCollection(SequenceableCollection)>>indexOf:
  |              |  |        |              1.0% {2219ms} 
OrderedCollection(SequenceableCollection)>>indexOf:ifAbsent:
  |              |  |        |                1.0% {2219ms} 
OrderedCollection(SequenceableCollection)>>indexOf:startingAt:ifAbsent:
  |              |  |      3.5% {7658ms} 
FM3MetaDescription>>attributeNamed:ifAbsent:
  |              |  |        1.3% {2780ms} 
FM3MetaDescription>>attributeNamed:ifAbsent:
  |              |  |        1.0% {2279ms} 
FMMultivalueLink(Collection)>>detect:ifNone:
  |              |2.0% {4280ms} MSEImporter(FMImporter)>>beginAttribute:
  |              |  1.9% {4231ms} FMFutureElement>>beginAttribute:
  |              |    1.6% {3513ms} PhexMatcher>>beTrue
  |              |      1.5% {3331ms} PhexMatcher>>true
  |              |        1.4% {3120ms} 
PhexMatcher>>expectedUnknownMessageToReturn:
  |            5.5% {12157ms} FMMSEParser>>Serial
  |              |4.6% {10104ms} MSEImporter(FMImporter)>>serial:
  |              |  4.6% {10089ms} FMFutureElement>>serial:
  |              |    4.6% {10087ms} MSEImporter(FMImporter)>>assign:to:
  |              |      4.0% {8756ms} FMDanglingReference>>resolve:
  |              |        3.2% {7072ms} FMFutureAttribute>>maybeEnd
  |              |          2.1% {4648ms} FM3PropertyDescription>>setOn:values:
  |              |            |2.1% {4554ms} 
FAMIXInvocation(Object)>>mmSetProperty:to:
  |              |            |  2.0% {4491ms} 
FM3PropertyDescription>>setOn:rawValue:
  |              |            |    1.2% {2665ms} 
FAMIXLocalVariable(FAMIXStructuralEntity)>>declaredType:
  |              |            |      1.2% {2655ms} FMMultivalueLink 
class>>on:update:from:to:
  |              |            |        1.2% {2643ms} 
FMMultivalueLink>>unsafeAdd:
  |              |            |          1.2% {2639ms} 
OrderedCollection(SequenceableCollection)>>includes:
  |              |            |            1.2% {2639ms} 
OrderedCollection(SequenceableCollection)>>indexOf:
  |              |            |              1.2% {2639ms} 
OrderedCollection(SequenceableCollection)>>indexOf:ifAbsent:
  |              |            |                1.2% {2639ms} 
OrderedCollection(SequenceableCollection)>>indexOf:startingAt:ifAbsent:
  |              |            |                  1.0% {2259ms} primitives
  |              |          1.1% {2370ms} 
FM3MetaDescription>>attributeNamed:ifAbsent:
  |            1.6% {3498ms} FMMSEParser>>tFULLNAME
  |              |1.2% {2677ms} Character>>isAlphaNumeric
  |            1.5% {3213ms} MSEImporter(FMImporter)>>beginElement:
  |              1.4% {3109ms} FMFutureElement class>>with:name:
  |                1.4% {3101ms} FMFutureElement>>with:name:
  |                  1.3% {2770ms} FM3MetaDescription>>createInstance
  |                    1.2% {2677ms} FAMIXParameter class(Behavior)>>new
1.5% {3206ms} MooseModel>>silentlyAddAll:
  1.4% {3128ms} MooseModel>>silentlyAdd:
--------------------------------
Process: other processes
--------------------------------
32.4% {71041ms} InputEventFetcher>>eventLoop
  32.4% {71037ms} InputEventFetcher>>waitForInput

**Leaves**
40.5% {88888ms} Array(SequenceableCollection)>>at:ifAbsent:
32.4% {71037ms} InputEventFetcher>>waitForInput
4.4% {9644ms} Array(SequenceableCollection)>>indexOf:startingAt:ifAbsent:
2.1% {4689ms} FMMSEParser>>tOPEN
2.0% {4476ms} SmallInteger(ProtoObject)>>~~
1.5% {3227ms} ByteString(String)>>=

**Memory**
        old                     +0 bytes
        young           +340,048 bytes
        used            +340,048 bytes
        free            -340,048 bytes

**GCs**
        full                    7 totalling 145,003ms (66.0% uptime), avg 
20715.0ms
        incr            3288 totalling 30,912ms (14.0% uptime), avg 9.0ms
        tenures         7,146,505 (avg 0 GCs/tenure)
        root table      0 overflows

Reply via email to