builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-062 starttime: 1476756870.7 results: success (0) buildid: 20161017190012 builduid: 68d392559ca84905b9d958f202459a8f revision: 6c3893afbb49689920d3189e1c5320867d3b3c97 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-17 19:14:30.701887) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-17 19:14:30.702317) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-17 19:14:30.702594) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-17 19:14:30.716878) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-17 19:14:30.717209) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-10-17 19:14:31-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 66.9M=0s 2016-10-17 19:14:31 (66.9 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.101148 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-17 19:14:30.832096) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-17 19:14:30.832408) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017808 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-17 19:14:30.881658) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-17 19:14:30.882022) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 6c3893afbb49689920d3189e1c5320867d3b3c97 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 6c3893afbb49689920d3189e1c5320867d3b3c97 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-10-17 19:14:31,293 truncating revision to first 12 chars 2016-10-17 19:14:31,293 Setting DEBUG logging. 2016-10-17 19:14:31,293 attempt 1/10 2016-10-17 19:14:31,293 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/6c3893afbb49?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-17 19:14:32,263 unpacking tar archive at: mozilla-inbound-6c3893afbb49/testing/mozharness/ program finished with exit code 0 elapsedTime=1.277425 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-17 19:14:32.172949) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-17 19:14:32.173270) ========= script_repo_revision: 6c3893afbb49689920d3189e1c5320867d3b3c97 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-17 19:14:32.173655) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-17 19:14:32.173937) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-17 19:14:32.181857) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-10-17 19:14:32.182161) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 19:14:32 INFO - MultiFileLogger online at 20161017 19:14:32 in /builds/slave/test 19:14:32 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 19:14:32 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 19:14:32 INFO - {'append_to_log': False, 19:14:32 INFO - 'base_work_dir': '/builds/slave/test', 19:14:32 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 19:14:32 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 19:14:32 INFO - 'branch': 'Mozilla-Inbound', 19:14:32 INFO - 'buildbot_json_path': 'buildprops.json', 19:14:32 INFO - 'config_files': ('talos/linux_config.py',), 19:14:32 INFO - 'default_actions': ('clobber', 19:14:32 INFO - 'read-buildbot-config', 19:14:32 INFO - 'download-and-extract', 19:14:32 INFO - 'populate-webroot', 19:14:32 INFO - 'create-virtualenv', 19:14:32 INFO - 'install', 19:14:32 INFO - 'run-tests'), 19:14:32 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 19:14:32 INFO - 'download_minidump_stackwalk': True, 19:14:32 INFO - 'download_symbols': 'ondemand', 19:14:32 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 19:14:32 INFO - 'tooltool.py': '/tools/tooltool.py', 19:14:32 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 19:14:32 INFO - '/tools/misc-python/virtualenv.py')}, 19:14:32 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 19:14:32 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 19:14:32 INFO - 'installer_path': 'installer.exe', 19:14:32 INFO - 'log_level': 'info', 19:14:32 INFO - 'log_name': 'talos', 19:14:32 INFO - 'log_to_console': True, 19:14:32 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 19:14:32 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 19:14:32 INFO - 'opt_config_files': (), 19:14:32 INFO - 'pip_index': False, 19:14:32 INFO - 'sps_profile': False, 19:14:32 INFO - 'sps_profile_interval': 0, 19:14:32 INFO - 'suite': 'dromaeojs', 19:14:32 INFO - 'system_bits': '32', 19:14:32 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 19:14:32 INFO - 'title': 'talos-linux64-ix-062', 19:14:32 INFO - 'tooltool_cache': '/builds/tooltool_cache', 19:14:32 INFO - 'use_talos_json': True, 19:14:32 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 19:14:32 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 19:14:32 INFO - 'work_dir': 'build'} 19:14:32 INFO - [mozharness: 2016-10-18 02:14:32.692795Z] Running clobber step. 19:14:32 INFO - Running pre-action listener: _resource_record_pre_action 19:14:32 INFO - Running main action method: clobber 19:14:32 INFO - rmtree: /builds/slave/test/build 19:14:32 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 19:14:33 INFO - Running post-action listener: _resource_record_post_action 19:14:33 INFO - [mozharness: 2016-10-18 02:14:33.155239Z] Finished clobber step (success) 19:14:33 INFO - [mozharness: 2016-10-18 02:14:33.155338Z] Running read-buildbot-config step. 19:14:33 INFO - Running pre-action listener: _resource_record_pre_action 19:14:33 INFO - Running main action method: read_buildbot_config 19:14:33 INFO - Using buildbot properties: 19:14:33 INFO - { 19:14:33 INFO - "project": "", 19:14:33 INFO - "product": "firefox", 19:14:33 INFO - "script_repo_revision": "production", 19:14:33 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs", 19:14:33 INFO - "repository": "", 19:14:33 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs", 19:14:33 INFO - "buildid": "20161017190012", 19:14:33 INFO - "stage_platform": "linux64-pgo", 19:14:33 INFO - "basedir": "/builds/slave/test", 19:14:33 INFO - "buildnumber": 1851, 19:14:33 INFO - "platform": "ubuntu64_hw", 19:14:33 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 19:14:33 INFO - "slavebuilddir": "test", 19:14:33 INFO - "branch": "mozilla-inbound", 19:14:33 INFO - "revision": "6c3893afbb49689920d3189e1c5320867d3b3c97", 19:14:33 INFO - "slavename": "talos-linux64-ix-062", 19:14:33 INFO - "builduid": "68d392559ca84905b9d958f202459a8f", 19:14:33 INFO - "repo_path": "integration/mozilla-inbound" 19:14:33 INFO - } 19:14:33 INFO - Found installer url https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 19:14:33 INFO - Found a test packages url https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.test_packages.json. 19:14:33 INFO - Running post-action listener: _resource_record_post_action 19:14:33 INFO - [mozharness: 2016-10-18 02:14:33.157966Z] Finished read-buildbot-config step (success) 19:14:33 INFO - [mozharness: 2016-10-18 02:14:33.158052Z] Running download-and-extract step. 19:14:33 INFO - Running pre-action listener: _resource_record_pre_action 19:14:33 INFO - Running main action method: download_and_extract 19:14:33 INFO - mkdir: /builds/slave/test/build/tests 19:14:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:33 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 19:14:33 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 19:14:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 19:14:33 INFO - Downloaded 1361 bytes. 19:14:33 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 19:14:33 INFO - Using the following test package requirements: 19:14:33 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 19:14:33 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 19:14:33 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 19:14:33 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 19:14:33 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 19:14:33 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 19:14:33 INFO - u'jsshell-linux-x86_64.zip'], 19:14:33 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 19:14:33 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 19:14:33 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 19:14:33 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 19:14:33 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 19:14:33 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 19:14:33 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 19:14:33 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 19:14:33 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 19:14:33 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 19:14:33 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 19:14:33 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 19:14:33 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 19:14:33 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 19:14:33 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 19:14:33 INFO - Http code: 200 19:14:33 INFO - via: 1.1 1b52a5dd431f9e3c81753e61dfdf467a.cloudfront.net (CloudFront) 19:14:33 INFO - x-amz-cf-id: -y8L7LTUs-L3JLxguvwMvYe91NEPiBWt28DmRPPCHS7uoEmQa8PJyQ== 19:14:33 INFO - x-amz-replication-status: COMPLETED 19:14:33 INFO - x-amz-version-id: SmAPDr88xTZkvPVxp2avdk.D.7fVKrB9 19:14:33 INFO - Expected file size: 22089412 19:14:33 INFO - Obtained file size: 22089412 19:14:37 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 19:14:37 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 19:14:37 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 19:14:37 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 19:14:37 INFO - Http code: 200 19:14:37 INFO - via: 1.1 b9a8ce441329f20cea895e08f19f1ec8.cloudfront.net (CloudFront) 19:14:37 INFO - x-amz-cf-id: 1QCe41j4pwjPM2kUSVLt4zabg3MD-FFGO5MQCILxMq4TBXcQpjvc9Q== 19:14:37 INFO - x-amz-replication-status: COMPLETED 19:14:37 INFO - x-amz-version-id: SmAPDr88xTZkvPVxp2avdk.D.7fVKrB9 19:14:37 INFO - Expected file size: 22089412 19:14:37 INFO - Obtained file size: 22089412 19:14:42 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 19:14:42 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 19:14:42 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 19:14:42 INFO - Http code: 200 19:14:42 INFO - via: 1.1 336f0e6ef9a3462f682d6ca49029b665.cloudfront.net (CloudFront) 19:14:42 INFO - x-amz-cf-id: o_NrC9yZK0zkAquthO1gIhoCwBQvCxHb4IX2BljtmnTYm27IOTamuQ== 19:14:42 INFO - x-amz-replication-status: COMPLETED 19:14:42 INFO - x-amz-version-id: 3MPlZB6QF05jqphQOXH7..Gc6qsLLqlH 19:14:42 INFO - Expected file size: 14409028 19:14:42 INFO - Obtained file size: 14409028 19:14:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:42 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 19:14:42 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 19:14:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 19:14:43 INFO - Downloaded 59475239 bytes. 19:14:43 INFO - Setting buildbot property build_url to https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 19:14:43 INFO - mkdir: /builds/slave/test/properties 19:14:43 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 19:14:43 INFO - Writing to file /builds/slave/test/properties/build_url 19:14:43 INFO - Contents: 19:14:43 INFO - build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 19:14:43 INFO - Running post-action listener: _resource_record_post_action 19:14:43 INFO - Running post-action listener: set_extra_try_arguments 19:14:43 INFO - [mozharness: 2016-10-18 02:14:43.677746Z] Finished download-and-extract step (success) 19:14:43 INFO - [mozharness: 2016-10-18 02:14:43.677971Z] Running populate-webroot step. 19:14:43 INFO - Running pre-action listener: _resource_record_pre_action 19:14:43 INFO - Running main action method: populate_webroot 19:14:43 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 19:14:43 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 19:14:43 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 19:14:43 INFO - '--tppagecycles', 19:14:43 INFO - '7'], 19:14:43 INFO - 'tests': ['tsvgm']}}, 19:14:43 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 19:14:43 INFO - 'tests': ['tresize', 'tcanvasmark']}, 19:14:43 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 19:14:43 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 19:14:43 INFO - 'tests': ['dromaeo_css', 'kraken']}, 19:14:43 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 19:14:43 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:14:43 INFO - 'talos_options': ['--disable-e10s'], 19:14:43 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:14:43 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:14:43 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:14:43 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:14:43 INFO - 'talos_options': ['--disable-e10s'], 19:14:43 INFO - 'tests': ['damp', 'tps']}, 19:14:43 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:14:43 INFO - 'tests': ['damp', 'tps']}, 19:14:43 INFO - 'g3': {'talos_options': ['--disable-e10s'], 19:14:43 INFO - 'tests': ['dromaeo_dom']}, 19:14:43 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 19:14:43 INFO - 'g4': {'talos_options': ['--disable-e10s'], 19:14:43 INFO - 'tests': ['basic_compositor_video']}, 19:14:43 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 19:14:43 INFO - 'other': {'talos_options': ['--disable-e10s'], 19:14:43 INFO - 'tests': ['a11yr', 19:14:43 INFO - 'ts_paint', 19:14:43 INFO - 'tpaint', 19:14:43 INFO - 'sessionrestore', 19:14:43 INFO - 'sessionrestore_no_auto_restore', 19:14:43 INFO - 'tabpaint']}, 19:14:43 INFO - 'other-e10s': {'tests': ['a11yr', 19:14:43 INFO - 'ts_paint', 19:14:43 INFO - 'tpaint', 19:14:43 INFO - 'sessionrestore', 19:14:43 INFO - 'sessionrestore_no_auto_restore', 19:14:43 INFO - 'tabpaint']}, 19:14:43 INFO - 'other-e10s_l64': {'tests': ['a11yr', 19:14:43 INFO - 'ts_paint', 19:14:43 INFO - 'tpaint', 19:14:43 INFO - 'sessionrestore', 19:14:43 INFO - 'sessionrestore_no_auto_restore', 19:14:43 INFO - 'tabpaint']}, 19:14:43 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 19:14:43 INFO - 'ts_paint', 19:14:43 INFO - 'tpaint', 19:14:43 INFO - 'sessionrestore', 19:14:43 INFO - 'sessionrestore_no_auto_restore', 19:14:43 INFO - 'tabpaint']}, 19:14:43 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 19:14:43 INFO - 'tests': ['a11yr', 19:14:43 INFO - 'ts_paint', 19:14:43 INFO - 'tpaint', 19:14:43 INFO - 'sessionrestore', 19:14:43 INFO - 'sessionrestore_no_auto_restore', 19:14:43 INFO - 'tabpaint']}, 19:14:43 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 19:14:43 INFO - 'tests': ['a11yr', 19:14:43 INFO - 'ts_paint', 19:14:43 INFO - 'tpaint', 19:14:43 INFO - 'sessionrestore', 19:14:43 INFO - 'sessionrestore_no_auto_restore', 19:14:43 INFO - 'tabpaint']}, 19:14:43 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 19:14:43 INFO - 'tests': ['tsvgx', 19:14:43 INFO - 'tsvgr_opacity', 19:14:43 INFO - 'tart', 19:14:43 INFO - 'tscrollx', 19:14:43 INFO - 'cart']}, 19:14:43 INFO - 'svgr-e10s': {'tests': ['tsvgx', 19:14:43 INFO - 'tsvgr_opacity', 19:14:43 INFO - 'tart', 19:14:43 INFO - 'tscrollx', 19:14:43 INFO - 'cart']}, 19:14:43 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:14:43 INFO - 'talos_options': ['--disable-e10s'], 19:14:43 INFO - 'tests': ['tp5o']}, 19:14:43 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:14:43 INFO - 'tests': ['tp5o']}, 19:14:43 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:14:43 INFO - 'talos_options': ['--disable-e10s', 19:14:43 INFO - '--xperf_path', 19:14:43 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:14:43 INFO - 'tests': ['tp5n']}, 19:14:43 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:14:43 INFO - 'talos_options': ['--xperf_path', 19:14:43 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:14:43 INFO - 'tests': ['tp5n']}}, 19:14:43 INFO - 'talos.zip': {'path': '', 19:14:43 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 19:14:43 INFO - Running post-action listener: _resource_record_post_action 19:14:43 INFO - [mozharness: 2016-10-18 02:14:43.695183Z] Finished populate-webroot step (success) 19:14:43 INFO - [mozharness: 2016-10-18 02:14:43.695271Z] Running create-virtualenv step. 19:14:43 INFO - Running pre-action listener: _resource_record_pre_action 19:14:43 INFO - Running main action method: create_virtualenv 19:14:43 INFO - Creating virtualenv /builds/slave/test/build/venv 19:14:43 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 19:14:43 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 19:14:43 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 19:14:43 INFO - Using real prefix '/usr' 19:14:43 INFO - New python executable in /builds/slave/test/build/venv/bin/python 19:14:44 INFO - Installing distribute.............................................................................................................................................................................................done. 19:14:46 INFO - Installing pip.................done. 19:14:46 INFO - Return code: 0 19:14:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 19:14:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 19:14:46 INFO - Reading from file tmpfile_stdout 19:14:46 INFO - Output received: 19:14:46 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 19:14:46 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 19:14:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:14:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:14:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb0d9616f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe3c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf09ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf06f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:14:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 19:14:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 19:14:46 INFO - Using env: {'DISPLAY': ':0', 19:14:46 INFO - 'HOME': '/home/cltbld', 19:14:46 INFO - 'LANG': 'en_US.UTF-8', 19:14:46 INFO - 'LANGUAGE': 'en_US:en', 19:14:46 INFO - 'LOGNAME': 'cltbld', 19:14:46 INFO - 'MAIL': '/var/mail/cltbld', 19:14:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:14:46 INFO - 'MOZ_NO_REMOTE': '1', 19:14:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:14:46 INFO - 'NO_EM_RESTART': '1', 19:14:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:14:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:14:46 INFO - 'PWD': '/builds/slave/test', 19:14:46 INFO - 'SHELL': '/bin/bash', 19:14:46 INFO - 'SHLVL': '1', 19:14:46 INFO - 'TERM': 'linux', 19:14:46 INFO - 'TMOUT': '86400', 19:14:46 INFO - 'USER': 'cltbld', 19:14:46 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 19:14:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:14:46 INFO - '_': '/tools/buildbot/bin/python'} 19:14:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:14:46 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 19:14:46 INFO - Cleaning up... 19:14:46 INFO - Return code: 0 19:14:46 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 19:14:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:14:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:14:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb0d9616f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe3c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf09ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf06f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:14:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 19:14:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 19:14:46 INFO - Using env: {'DISPLAY': ':0', 19:14:46 INFO - 'HOME': '/home/cltbld', 19:14:46 INFO - 'LANG': 'en_US.UTF-8', 19:14:46 INFO - 'LANGUAGE': 'en_US:en', 19:14:46 INFO - 'LOGNAME': 'cltbld', 19:14:46 INFO - 'MAIL': '/var/mail/cltbld', 19:14:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:14:46 INFO - 'MOZ_NO_REMOTE': '1', 19:14:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:14:46 INFO - 'NO_EM_RESTART': '1', 19:14:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:14:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:14:46 INFO - 'PWD': '/builds/slave/test', 19:14:46 INFO - 'SHELL': '/bin/bash', 19:14:46 INFO - 'SHLVL': '1', 19:14:46 INFO - 'TERM': 'linux', 19:14:46 INFO - 'TMOUT': '86400', 19:14:46 INFO - 'USER': 'cltbld', 19:14:46 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 19:14:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:14:46 INFO - '_': '/tools/buildbot/bin/python'} 19:14:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:14:46 INFO - Downloading/unpacking psutil>=3.1.1 19:14:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 19:14:48 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:14:48 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:14:48 INFO - Installing collected packages: psutil 19:14:48 INFO - Running setup.py install for psutil 19:14:49 INFO - building 'psutil._psutil_linux' extension 19:14:49 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 19:14:49 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 19:14:49 INFO - building 'psutil._psutil_posix' extension 19:14:49 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 19:14:49 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 19:14:49 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:14:49 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:14:49 INFO - Successfully installed psutil 19:14:49 INFO - Cleaning up... 19:14:49 INFO - Return code: 0 19:14:49 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 19:14:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:14:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:14:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb0d9616f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe3c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf09ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf06f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:14:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 19:14:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 19:14:49 INFO - Using env: {'DISPLAY': ':0', 19:14:49 INFO - 'HOME': '/home/cltbld', 19:14:49 INFO - 'LANG': 'en_US.UTF-8', 19:14:49 INFO - 'LANGUAGE': 'en_US:en', 19:14:49 INFO - 'LOGNAME': 'cltbld', 19:14:49 INFO - 'MAIL': '/var/mail/cltbld', 19:14:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:14:49 INFO - 'MOZ_NO_REMOTE': '1', 19:14:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:14:49 INFO - 'NO_EM_RESTART': '1', 19:14:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:14:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:14:49 INFO - 'PWD': '/builds/slave/test', 19:14:49 INFO - 'SHELL': '/bin/bash', 19:14:49 INFO - 'SHLVL': '1', 19:14:49 INFO - 'TERM': 'linux', 19:14:49 INFO - 'TMOUT': '86400', 19:14:49 INFO - 'USER': 'cltbld', 19:14:49 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 19:14:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:14:49 INFO - '_': '/tools/buildbot/bin/python'} 19:14:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:14:49 INFO - Downloading/unpacking mozsystemmonitor==0.3 19:14:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:51 INFO - Downloading mozsystemmonitor-0.3.tar.gz 19:14:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 19:14:51 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 19:14:51 INFO - Installing collected packages: mozsystemmonitor 19:14:51 INFO - Running setup.py install for mozsystemmonitor 19:14:51 INFO - Successfully installed mozsystemmonitor 19:14:51 INFO - Cleaning up... 19:14:51 INFO - Return code: 0 19:14:51 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 19:14:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:14:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:14:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:51 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb0d9616f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe3c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf09ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf06f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:14:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 19:14:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 19:14:51 INFO - Using env: {'DISPLAY': ':0', 19:14:51 INFO - 'HOME': '/home/cltbld', 19:14:51 INFO - 'LANG': 'en_US.UTF-8', 19:14:51 INFO - 'LANGUAGE': 'en_US:en', 19:14:51 INFO - 'LOGNAME': 'cltbld', 19:14:51 INFO - 'MAIL': '/var/mail/cltbld', 19:14:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:14:51 INFO - 'MOZ_NO_REMOTE': '1', 19:14:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:14:51 INFO - 'NO_EM_RESTART': '1', 19:14:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:14:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:14:51 INFO - 'PWD': '/builds/slave/test', 19:14:51 INFO - 'SHELL': '/bin/bash', 19:14:51 INFO - 'SHLVL': '1', 19:14:51 INFO - 'TERM': 'linux', 19:14:51 INFO - 'TMOUT': '86400', 19:14:51 INFO - 'USER': 'cltbld', 19:14:51 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 19:14:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:14:51 INFO - '_': '/tools/buildbot/bin/python'} 19:14:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:14:52 INFO - Downloading/unpacking jsonschema==2.5.1 19:14:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:53 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 19:14:53 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 19:14:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:54 INFO - Downloading functools32-3.2.3-2.tar.gz 19:14:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 19:14:54 INFO - warning: no files found matching '*.txt' 19:14:54 INFO - no previously-included directories found matching 'build' 19:14:54 INFO - no previously-included directories found matching 'dist' 19:14:54 INFO - no previously-included directories found matching '.git*' 19:14:54 INFO - Installing collected packages: jsonschema, functools32 19:14:54 INFO - Running setup.py install for functools32 19:14:54 INFO - warning: no files found matching '*.txt' 19:14:54 INFO - no previously-included directories found matching 'build' 19:14:54 INFO - no previously-included directories found matching 'dist' 19:14:54 INFO - no previously-included directories found matching '.git*' 19:14:54 INFO - Successfully installed jsonschema functools32 19:14:54 INFO - Cleaning up... 19:14:54 INFO - Return code: 0 19:14:54 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 19:14:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:14:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:14:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb0d9616f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe3c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf09ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf06f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:14:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 19:14:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 19:14:54 INFO - Using env: {'DISPLAY': ':0', 19:14:54 INFO - 'HOME': '/home/cltbld', 19:14:54 INFO - 'LANG': 'en_US.UTF-8', 19:14:54 INFO - 'LANGUAGE': 'en_US:en', 19:14:54 INFO - 'LOGNAME': 'cltbld', 19:14:54 INFO - 'MAIL': '/var/mail/cltbld', 19:14:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:14:54 INFO - 'MOZ_NO_REMOTE': '1', 19:14:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:14:54 INFO - 'NO_EM_RESTART': '1', 19:14:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:14:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:14:54 INFO - 'PWD': '/builds/slave/test', 19:14:54 INFO - 'SHELL': '/bin/bash', 19:14:54 INFO - 'SHLVL': '1', 19:14:54 INFO - 'TERM': 'linux', 19:14:54 INFO - 'TMOUT': '86400', 19:14:54 INFO - 'USER': 'cltbld', 19:14:54 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 19:14:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:14:54 INFO - '_': '/tools/buildbot/bin/python'} 19:14:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:14:54 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 19:14:54 INFO - Cleaning up... 19:14:54 INFO - Return code: 0 19:14:54 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 19:14:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:14:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:14:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb0d9616f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe3c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf09ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf06f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:14:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 19:14:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 19:14:54 INFO - Using env: {'DISPLAY': ':0', 19:14:54 INFO - 'HOME': '/home/cltbld', 19:14:54 INFO - 'LANG': 'en_US.UTF-8', 19:14:54 INFO - 'LANGUAGE': 'en_US:en', 19:14:54 INFO - 'LOGNAME': 'cltbld', 19:14:54 INFO - 'MAIL': '/var/mail/cltbld', 19:14:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:14:54 INFO - 'MOZ_NO_REMOTE': '1', 19:14:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:14:54 INFO - 'NO_EM_RESTART': '1', 19:14:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:14:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:14:54 INFO - 'PWD': '/builds/slave/test', 19:14:54 INFO - 'SHELL': '/bin/bash', 19:14:54 INFO - 'SHLVL': '1', 19:14:54 INFO - 'TERM': 'linux', 19:14:54 INFO - 'TMOUT': '86400', 19:14:54 INFO - 'USER': 'cltbld', 19:14:54 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 19:14:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:14:54 INFO - '_': '/tools/buildbot/bin/python'} 19:14:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:14:54 INFO - Downloading/unpacking blobuploader==1.2.4 19:14:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:56 INFO - Downloading blobuploader-1.2.4.tar.gz 19:14:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 19:14:56 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 19:14:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 19:14:57 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 19:14:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:14:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:14:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:14:57 INFO - Downloading docopt-0.6.1.tar.gz 19:14:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 19:14:57 INFO - Installing collected packages: blobuploader, requests, docopt 19:14:57 INFO - Running setup.py install for blobuploader 19:14:57 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 19:14:57 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 19:14:57 INFO - Running setup.py install for requests 19:14:58 INFO - Running setup.py install for docopt 19:14:58 INFO - Successfully installed blobuploader requests docopt 19:14:58 INFO - Cleaning up... 19:14:58 INFO - Return code: 0 19:14:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:14:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:14:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:14:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:14:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:14:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb0d9616f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe3c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf09ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf06f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:14:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 19:14:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:14:58 INFO - Using env: {'DISPLAY': ':0', 19:14:58 INFO - 'HOME': '/home/cltbld', 19:14:58 INFO - 'LANG': 'en_US.UTF-8', 19:14:58 INFO - 'LANGUAGE': 'en_US:en', 19:14:58 INFO - 'LOGNAME': 'cltbld', 19:14:58 INFO - 'MAIL': '/var/mail/cltbld', 19:14:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:14:58 INFO - 'MOZ_NO_REMOTE': '1', 19:14:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:14:58 INFO - 'NO_EM_RESTART': '1', 19:14:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:14:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:14:58 INFO - 'PWD': '/builds/slave/test', 19:14:58 INFO - 'SHELL': '/bin/bash', 19:14:58 INFO - 'SHLVL': '1', 19:14:58 INFO - 'TERM': 'linux', 19:14:58 INFO - 'TMOUT': '86400', 19:14:58 INFO - 'USER': 'cltbld', 19:14:58 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 19:14:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:14:58 INFO - '_': '/tools/buildbot/bin/python'} 19:14:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:14:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 19:14:58 INFO - Running setup.py (path:/tmp/pip-zG22MJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 19:14:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 19:14:58 INFO - Running setup.py (path:/tmp/pip-sjCjTD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 19:14:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 19:14:58 INFO - Running setup.py (path:/tmp/pip-lQFOAE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 19:14:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 19:14:58 INFO - Running setup.py (path:/tmp/pip-NqUdMj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 19:14:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 19:14:58 INFO - Running setup.py (path:/tmp/pip-ZS0zAQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 19:14:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 19:14:58 INFO - Running setup.py (path:/tmp/pip-mR4bnB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 19:14:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 19:14:58 INFO - Running setup.py (path:/tmp/pip-2YXGNK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 19:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 19:14:59 INFO - Running setup.py (path:/tmp/pip-WZKAv2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 19:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 19:14:59 INFO - Running setup.py (path:/tmp/pip-M4f3D9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 19:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 19:14:59 INFO - Running setup.py (path:/tmp/pip-yJ16aS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 19:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 19:14:59 INFO - Running setup.py (path:/tmp/pip-7X91yT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 19:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 19:14:59 INFO - Running setup.py (path:/tmp/pip-3mPsnN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 19:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 19:14:59 INFO - Running setup.py (path:/tmp/pip-9ypmbi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 19:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 19:14:59 INFO - Running setup.py (path:/tmp/pip-ti9LkH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 19:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 19:14:59 INFO - Running setup.py (path:/tmp/pip-WKKvXA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 19:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 19:14:59 INFO - Running setup.py (path:/tmp/pip-vfbvEq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 19:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 19:14:59 INFO - Running setup.py (path:/tmp/pip-tx4S2U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 19:14:59 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 19:14:59 INFO - Running setup.py install for manifestparser 19:14:59 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 19:14:59 INFO - Running setup.py install for mozcrash 19:14:59 INFO - Running setup.py install for mozdebug 19:15:00 INFO - Running setup.py install for mozdevice 19:15:00 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 19:15:00 INFO - Installing dm script to /builds/slave/test/build/venv/bin 19:15:00 INFO - Running setup.py install for mozfile 19:15:00 INFO - Running setup.py install for mozhttpd 19:15:00 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 19:15:00 INFO - Running setup.py install for mozinfo 19:15:00 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 19:15:00 INFO - Running setup.py install for mozInstall 19:15:00 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 19:15:00 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 19:15:00 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 19:15:00 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 19:15:00 INFO - Running setup.py install for mozleak 19:15:00 INFO - Running setup.py install for mozlog 19:15:00 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 19:15:00 INFO - Running setup.py install for moznetwork 19:15:00 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 19:15:00 INFO - Running setup.py install for mozprocess 19:15:00 INFO - Running setup.py install for mozprofile 19:15:01 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 19:15:01 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 19:15:01 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 19:15:01 INFO - Running setup.py install for mozrunner 19:15:01 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 19:15:01 INFO - Running setup.py install for mozscreenshot 19:15:01 INFO - Running setup.py install for moztest 19:15:01 INFO - Running setup.py install for mozversion 19:15:01 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 19:15:01 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 19:15:01 INFO - Cleaning up... 19:15:01 INFO - Return code: 0 19:15:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:15:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:15:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:15:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:15:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:15:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:15:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:15:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb0d9616f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe3c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf09ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf06f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:15:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 19:15:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:15:01 INFO - Using env: {'DISPLAY': ':0', 19:15:01 INFO - 'HOME': '/home/cltbld', 19:15:01 INFO - 'LANG': 'en_US.UTF-8', 19:15:01 INFO - 'LANGUAGE': 'en_US:en', 19:15:01 INFO - 'LOGNAME': 'cltbld', 19:15:01 INFO - 'MAIL': '/var/mail/cltbld', 19:15:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:15:01 INFO - 'MOZ_NO_REMOTE': '1', 19:15:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:15:01 INFO - 'NO_EM_RESTART': '1', 19:15:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:15:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:15:01 INFO - 'PWD': '/builds/slave/test', 19:15:01 INFO - 'SHELL': '/bin/bash', 19:15:01 INFO - 'SHLVL': '1', 19:15:01 INFO - 'TERM': 'linux', 19:15:01 INFO - 'TMOUT': '86400', 19:15:01 INFO - 'USER': 'cltbld', 19:15:01 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 19:15:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:15:01 INFO - '_': '/tools/buildbot/bin/python'} 19:15:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:15:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 19:15:01 INFO - Running setup.py (path:/tmp/pip-OfjuzK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 19:15:01 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 19:15:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 19:15:01 INFO - Running setup.py (path:/tmp/pip-g7zTf1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 19:15:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 19:15:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 19:15:01 INFO - Running setup.py (path:/tmp/pip-YCBADx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 19:15:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 19:15:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 19:15:01 INFO - Running setup.py (path:/tmp/pip-2Nll2w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 19:15:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 19:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 19:15:02 INFO - Running setup.py (path:/tmp/pip-vJLYGT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 19:15:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 19:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 19:15:02 INFO - Running setup.py (path:/tmp/pip-n6drqY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 19:15:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 19:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 19:15:02 INFO - Running setup.py (path:/tmp/pip-WLQrF0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 19:15:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 19:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 19:15:02 INFO - Running setup.py (path:/tmp/pip-THvEjp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 19:15:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 19:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 19:15:02 INFO - Running setup.py (path:/tmp/pip-63prRE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 19:15:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 19:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 19:15:02 INFO - Running setup.py (path:/tmp/pip-6TcL_s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 19:15:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 19:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 19:15:02 INFO - Running setup.py (path:/tmp/pip-sQozOU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 19:15:02 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 19:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 19:15:02 INFO - Running setup.py (path:/tmp/pip-tL0R18-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 19:15:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 19:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 19:15:02 INFO - Running setup.py (path:/tmp/pip-4kjqU6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 19:15:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 19:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 19:15:02 INFO - Running setup.py (path:/tmp/pip-Z2jR0i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 19:15:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 19:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 19:15:02 INFO - Running setup.py (path:/tmp/pip-2txbMs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 19:15:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 19:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 19:15:02 INFO - Running setup.py (path:/tmp/pip-AWpsSO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 19:15:02 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 19:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 19:15:02 INFO - Running setup.py (path:/tmp/pip-YU1OrX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 19:15:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 19:15:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 19:15:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 19:15:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 19:15:03 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 19:15:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 19:15:03 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 19:15:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:15:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:15:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:15:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:15:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:15:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:15:04 INFO - Downloading blessings-1.6.tar.gz 19:15:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 19:15:05 INFO - Installing collected packages: blessings 19:15:05 INFO - Running setup.py install for blessings 19:15:05 INFO - Successfully installed blessings 19:15:05 INFO - Cleaning up... 19:15:05 INFO - Return code: 0 19:15:05 INFO - Done creating virtualenv /builds/slave/test/build/venv. 19:15:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 19:15:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 19:15:05 INFO - Reading from file tmpfile_stdout 19:15:05 INFO - Current package versions: 19:15:05 INFO - argparse == 1.2.1 19:15:05 INFO - blessings == 1.6 19:15:05 INFO - blobuploader == 1.2.4 19:15:05 INFO - docopt == 0.6.1 19:15:05 INFO - functools32 == 3.2.3-2 19:15:05 INFO - jsonschema == 2.5.1 19:15:05 INFO - manifestparser == 1.1 19:15:05 INFO - mozInstall == 1.12 19:15:05 INFO - mozcrash == 0.17 19:15:05 INFO - mozdebug == 0.1 19:15:05 INFO - mozdevice == 0.48 19:15:05 INFO - mozfile == 1.2 19:15:05 INFO - mozhttpd == 0.7 19:15:05 INFO - mozinfo == 0.9 19:15:05 INFO - mozleak == 0.1 19:15:05 INFO - mozlog == 3.4 19:15:05 INFO - moznetwork == 0.27 19:15:05 INFO - mozprocess == 0.23 19:15:05 INFO - mozprofile == 0.28 19:15:05 INFO - mozrunner == 6.12 19:15:05 INFO - mozscreenshot == 0.1 19:15:05 INFO - mozsystemmonitor == 0.3 19:15:05 INFO - moztest == 0.7 19:15:05 INFO - mozversion == 1.4 19:15:05 INFO - psutil == 3.1.1 19:15:05 INFO - requests == 1.2.3 19:15:05 INFO - wsgiref == 0.1.2 19:15:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:15:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:15:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:15:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:15:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:15:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:15:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:15:05 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb0d9616f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe3c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf09ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf06f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:15:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 19:15:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:15:05 INFO - Using env: {'DISPLAY': ':0', 19:15:05 INFO - 'HOME': '/home/cltbld', 19:15:05 INFO - 'LANG': 'en_US.UTF-8', 19:15:05 INFO - 'LANGUAGE': 'en_US:en', 19:15:05 INFO - 'LOGNAME': 'cltbld', 19:15:05 INFO - 'MAIL': '/var/mail/cltbld', 19:15:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:15:05 INFO - 'MOZ_NO_REMOTE': '1', 19:15:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:15:05 INFO - 'NO_EM_RESTART': '1', 19:15:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:15:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:15:05 INFO - 'PWD': '/builds/slave/test', 19:15:05 INFO - 'SHELL': '/bin/bash', 19:15:05 INFO - 'SHLVL': '1', 19:15:05 INFO - 'TERM': 'linux', 19:15:05 INFO - 'TMOUT': '86400', 19:15:05 INFO - 'USER': 'cltbld', 19:15:05 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 19:15:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:15:05 INFO - '_': '/tools/buildbot/bin/python'} 19:15:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:15:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 19:15:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 19:15:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 19:15:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 19:15:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 19:15:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 19:15:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 19:15:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 19:15:05 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 19:15:05 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 19:15:05 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 19:15:05 INFO - Cleaning up... 19:15:05 INFO - Return code: 0 19:15:05 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 19:15:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:15:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:15:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:15:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:15:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:15:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:15:05 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb0d9616f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe3c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf09ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf06f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf081d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:15:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 19:15:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 19:15:05 INFO - Using env: {'DISPLAY': ':0', 19:15:05 INFO - 'HOME': '/home/cltbld', 19:15:05 INFO - 'LANG': 'en_US.UTF-8', 19:15:05 INFO - 'LANGUAGE': 'en_US:en', 19:15:05 INFO - 'LOGNAME': 'cltbld', 19:15:05 INFO - 'MAIL': '/var/mail/cltbld', 19:15:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:15:05 INFO - 'MOZ_NO_REMOTE': '1', 19:15:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:15:05 INFO - 'NO_EM_RESTART': '1', 19:15:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:15:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:15:05 INFO - 'PWD': '/builds/slave/test', 19:15:05 INFO - 'SHELL': '/bin/bash', 19:15:05 INFO - 'SHLVL': '1', 19:15:05 INFO - 'TERM': 'linux', 19:15:05 INFO - 'TMOUT': '86400', 19:15:05 INFO - 'USER': 'cltbld', 19:15:05 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 19:15:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:15:05 INFO - '_': '/tools/buildbot/bin/python'} 19:15:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:15:05 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 19:15:05 INFO - Cleaning up... 19:15:05 INFO - Return code: 0 19:15:05 INFO - Running post-action listener: _resource_record_post_action 19:15:05 INFO - Running post-action listener: _start_resource_monitoring 19:15:05 INFO - Starting resource monitoring. 19:15:05 INFO - [mozharness: 2016-10-18 02:15:05.911824Z] Finished create-virtualenv step (success) 19:15:05 INFO - [mozharness: 2016-10-18 02:15:05.912423Z] Running install step. 19:15:05 INFO - Running pre-action listener: _resource_record_pre_action 19:15:05 INFO - Running main action method: install 19:15:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 19:15:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 19:15:06 INFO - Reading from file tmpfile_stdout 19:15:06 INFO - Detecting whether we're running mozinstall >=1.0... 19:15:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 19:15:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 19:15:06 INFO - Reading from file tmpfile_stdout 19:15:06 INFO - Output received: 19:15:06 INFO - Usage: mozinstall [options] installer 19:15:06 INFO - Options: 19:15:06 INFO - -h, --help show this help message and exit 19:15:06 INFO - -d DEST, --destination=DEST 19:15:06 INFO - Directory to install application into. [default: 19:15:06 INFO - "/builds/slave/test"] 19:15:06 INFO - --app=APP Application being installed. [default: firefox] 19:15:06 INFO - mkdir: /builds/slave/test/build/application 19:15:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 19:15:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 19:15:23 INFO - Reading from file tmpfile_stdout 19:15:23 INFO - Output received: 19:15:23 INFO - /builds/slave/test/build/application/firefox/firefox 19:15:23 INFO - Running post-action listener: _resource_record_post_action 19:15:23 INFO - [mozharness: 2016-10-18 02:15:23.173115Z] Finished install step (success) 19:15:23 INFO - [mozharness: 2016-10-18 02:15:23.173391Z] Running run-tests step. 19:15:23 INFO - Running pre-action listener: _resource_record_pre_action 19:15:23 INFO - Running main action method: run_tests 19:15:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 19:15:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 19:15:23 INFO - Python 2.7.3 19:15:23 INFO - Return code: 0 19:15:23 INFO - grabbing minidump binary from tooltool 19:15:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:15:23 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf06f60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf07d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf081d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 19:15:23 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 19:15:23 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 19:15:23 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 19:15:23 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 19:15:23 INFO - Return code: 0 19:15:23 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 19:15:23 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 19:15:23 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 19:15:23 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 19:15:23 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 19:15:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 19:15:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-062 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 19:15:23 INFO - Using env: {'DISPLAY': ':0', 19:15:23 INFO - 'HOME': '/home/cltbld', 19:15:23 INFO - 'LANG': 'en_US.UTF-8', 19:15:23 INFO - 'LANGUAGE': 'en_US:en', 19:15:23 INFO - 'LOGNAME': 'cltbld', 19:15:23 INFO - 'MAIL': '/var/mail/cltbld', 19:15:23 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 19:15:23 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 19:15:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:15:23 INFO - 'MOZ_NO_REMOTE': '1', 19:15:23 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 19:15:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:15:23 INFO - 'NO_EM_RESTART': '1', 19:15:23 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:15:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:15:23 INFO - 'PWD': '/builds/slave/test', 19:15:23 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 19:15:23 INFO - 'SHELL': '/bin/bash', 19:15:23 INFO - 'SHLVL': '1', 19:15:23 INFO - 'TERM': 'linux', 19:15:23 INFO - 'TMOUT': '86400', 19:15:23 INFO - 'USER': 'cltbld', 19:15:23 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131', 19:15:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:15:23 INFO - '_': '/tools/buildbot/bin/python'} 19:15:23 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 19:15:23 INFO - mozversion application_buildid: 20161017153002 19:15:23 INFO - mozversion application_changeset: 6c3893afbb49689920d3189e1c5320867d3b3c97 19:15:23 INFO - mozversion application_display_name: Nightly 19:15:23 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 19:15:23 INFO - mozversion application_name: Firefox 19:15:23 INFO - mozversion application_remotingname: firefox 19:15:23 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 19:15:23 INFO - mozversion application_vendor: Mozilla 19:15:23 INFO - mozversion application_version: 52.0a1 19:15:23 INFO - mozversion platform_buildid: 20161017153002 19:15:23 INFO - mozversion platform_changeset: 6c3893afbb49689920d3189e1c5320867d3b3c97 19:15:23 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 19:15:23 INFO - mozversion platform_version: 52.0a1 19:15:23 INFO - using testdate: 1476756923 19:15:23 INFO - actual date: 1476756923 19:15:23 INFO - starting webserver on 'localhost:41121' 19:15:23 INFO - SUITE-START | Running 2 tests 19:15:23 INFO - TEST-START | dromaeo_css 19:15:23 INFO - operating with platform_type : linux_ 19:15:23 INFO - Initialising browser for dromaeo_css test... 19:15:23 INFO - TEST-INFO | started process 14129 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpIQNQMN/profile http://localhost:41121/getInfo.html) 19:15:27 INFO - PROCESS | 14129 | __metrics Screen width/height:1600/1200 19:15:27 INFO - PROCESS | 14129 | colorDepth:24 19:15:27 INFO - PROCESS | 14129 | Browser inner width/height: 1024/697 19:15:27 INFO - PROCESS | 14129 | __metrics 19:15:27 INFO - PROCESS | 14129 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 19:15:27 INFO - PROCESS | 14129 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 19:15:28 INFO - PROCESS | 14129 | console.error: PushService: 19:15:28 INFO - PROCESS | 14129 | stateChangeProcessEnqueue: Error transitioning state 19:15:28 INFO - PROCESS | 14129 | UnknownError 19:15:28 INFO - TEST-INFO | 14129: exit 0 19:15:28 INFO - Browser initialized. 19:15:28 INFO - Running cycle 1/1 for dromaeo_css test... 19:15:28 INFO - TEST-INFO | started process 14211 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpIQNQMN/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 19:15:40 INFO - PROCESS | 14211 | RSS: Main: 172011520 19:15:40 INFO - PROCESS | 14211 | 19:16:31 INFO - PROCESS | 14211 | 1476756991985 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 19:18:43 INFO - PROCESS | 14211 | Cycle 1(1): loaded http://localhost:41121/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41121/tests/dromaeo/cssquery-ext.html) 19:18:44 INFO - PROCESS | 14211 | RSS: Main: 288415744 19:18:44 INFO - PROCESS | 14211 | 19:21:47 INFO - PROCESS | 14211 | Cycle 1(1): loaded http://localhost:41121/tests/dromaeo/cssquery-ext.html (next: http://localhost:41121/tests/dromaeo/cssquery-jquery.html) 19:21:47 INFO - PROCESS | 14211 | RSS: Main: 278286336 19:21:47 INFO - PROCESS | 14211 | 19:24:49 INFO - PROCESS | 14211 | Cycle 1(1): loaded http://localhost:41121/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41121/tests/dromaeo/cssquery-mootools.html) 19:24:50 INFO - PROCESS | 14211 | RSS: Main: 217829376 19:24:50 INFO - PROCESS | 14211 | 19:27:52 INFO - PROCESS | 14211 | Cycle 1(1): loaded http://localhost:41121/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41121/tests/dromaeo/cssquery-prototype.html) 19:27:53 INFO - PROCESS | 14211 | RSS: Main: 266813440 19:27:53 INFO - PROCESS | 14211 | 19:30:56 INFO - PROCESS | 14211 | Cycle 1(1): loaded http://localhost:41121/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41121/tests/dromaeo/cssquery-yui.html) 19:30:56 INFO - PROCESS | 14211 | RSS: Main: 213266432 19:30:56 INFO - PROCESS | 14211 | 19:33:59 INFO - PROCESS | 14211 | Cycle 1(1): loaded http://localhost:41121/tests/dromaeo/cssquery-yui.html (next: http://localhost:41121/tests/dromaeo/cssquery-dojo.html) 19:33:59 INFO - PROCESS | 14211 | RSS: Main: 297316352 19:33:59 INFO - PROCESS | 14211 | 19:33:59 INFO - PROCESS | 14211 | __start_tp_report 19:33:59 INFO - PROCESS | 14211 | _x_x_mozilla_page_load 19:33:59 INFO - PROCESS | 14211 | _x_x_mozilla_page_load_details 19:33:59 INFO - PROCESS | 14211 | |i|pagename|runs| 19:33:59 INFO - PROCESS | 14211 | |0;dojo.html;2991.8354490503025;3016.969830301696;3047.5276332168514;3068.509038553832;3072.2626569623285;5048.848534543969;5139.691618502892;5200.219967004947;5298.417174110849;5380.139177731558;5132.974335128329;5158.484151584839;5162.741862906859;5163.974180129094;5182.4299327073995;4634.582887540129;4681.555252251031;4697.342372067913;4727.858164255061;4738.502457241992;4762.380890484233;4764.690295130806;4772.976135119319;4797.184478638623;4801.831935882227;4715.834945776898;4719.6460265480055;4741.170295198343;4777.187878060738;4787.353707249512;4823.541763532458;4827.227643577028;4835.178019736618;4845.806167753286;4885.658003939726;4611.515790841981;4643.16423043852;4728.172569800306;4739.597134243593;4792.568668819823;5251.159814429673;5255.76349064293;5262.368515778093;5276.7889284428575;5353.732313384354;5563.388027316992;5629.324481062258;5631.239782629334;5639;5640.689762063085;5380.4350543192795;5505;5616.803411880605;5702.572307076985;5760.74076666551;5242.344706911636;5243.554297884646;5256.342957130359;5303.04545181871;5303.575713942914;5685.431456854364;5687.3459552152035;5700.800471983461;5705.144228365778;5708.857278568069;5247.18668606359;5336.226247194135;5536.446355364512;5541.473560011793;5609.66342019472;5469.042917489503;5519.806806761744;5533.170024496278;5566.860828479321;5599.44005599445;5466.562674985991;5512.366077901012;5514.310711161105;5519.806806761744;5526.253955715927;5350.678959262456;5481.314835645544;5539.362973258047;5543.223948647193;5597.580181486404;4173.791310434466;4218.135282267128;4219.725717828332;4221.5567365426805;4223.345381465878;3791.981040094837;3815.2560250751394;3821.7898015608853;3823.9426408603895;3842.3083844908183;5270.5256526912;5318.44156363584;5330.093884039723;5330.200469929541;5335.839924802262;5594.888102237933;5605.523530499871;5607.046802043662;5608.355039170548;5609.15862620602;5093;5219.347581552306;5277.445868183862;5289.20661900718;5289.603279754034;4713.787879545429;4747.976260118747;4764.952350476451;4769.76151192439;4769.928451073237;5648.068068768689;5657.038303488417;5658.660480371191;5667.319921609434;5667.348254950569;5449.509544141047;5479.123340265538;5490.231367608458;5494.80768173128;5498.835034948958;5624.212610234488;5634.6337488063145;5645.548356131581;5645.802396916089;5655.4910058094965;5431.4840090191365;5449.427810080043;5456.48163424474;5457.5633949283165;5459.126539753779;5535.501804837584;5535.916961245665;5540.833774986757;5547.389787123494;5553.972230138985;5473.863153421196;5475.616706830484;5500.724963751716;5529.115341545334;5538.446155384429;5522.116461366162;5522.2544956431975;5522.641028333145;5530.059889818821;5615.073512870494;5263.289455923555;5297.2583838263445;5337.199420086863;5351.010063138332;5515.338159420895;5415.133578627559;5446.183072538993;5448.56411487088;5461.508464238238;5513.007658621486;5250.684958902478;5270.446603106619;5286.259923610621;5292.52367286946;5300.257963884982 19:33:59 INFO - PROCESS | 14211 | |1;ext.html;549.2127175324525;574.43992107695;600.4355905448879;611.5566214494489;625.1622825413945;30272.243193920163;40635.593644063585;41530;41602.37596436056;41691.95770105745;43275;43516;43576;43656.78171609146;43803.37179769216;8013.47912385696;8765.254953328958;8897.466152030898;8918.063603321654;8924.598393072294;8156.143604921487;10360.740981475486;10606.734831629194;10608.840867386956;10977.06694930932;10691.946540267289;10741.83887241692;10770.29993050453;10774.946125269362;10784.73038174044;10582.894171058268;10641.308314959502;10655.680329590046;10663.306885052525;10667.83998240027;10136.732908386452;10220.89779102207;10255.33340332876;10311.742206444824;10332.741681457948;40240.396394054114;40535.797321013204;40540;40886.1822763546;41004.79497602493;3329.5338652588657;3367.6127245366606;3508.7193024557973;3599.748017638766;3765.2093060457337;30048.39903201924;30660.386792264253;30667.693323066705;30733;30798.23004424885;4033.899152521181;4084.8366065357645;4257.127288905798;4307.224699554079;4390.978045109786;297626;299119;299199;301389;301423;32730;33574.832125839705;54613.180802288;54750;54932.450675493536;34847.65152348444;35044.47433288502;35164;35188.47217291692;35207.64792352095;14326.212058336683;14396.496122635657;14431;14435.92782036083;14442.350094245785;10780.083692886035;10874.075703565286;11169.273997190157;11243.550257989753;11263.831042534368;7893.842123157505;7916.327112195413;7970.242826931432;7986.720464783821;8042.638081286356;3108.2695566541843;3134.7492200623897;3147.653758086609;3147.8583463744185;3164.3829453256394;863.6933888469503;926.4487629860222;953.7520244736419;963.9759006024906;1037.7509397744639;29932.700672993426;31262.687373125977;31555.526667100014;31705.365892682017;32178.19554511156;1029.577873072052;1049.8740151181908;1052.1267348101057;1098.3903933316926;1191.5710344276054;16078.517644470685;16737.748933766004;16825.831741682672;16907.408240711517;16925.23836427364;451423;458115;458959;460183;461271;54946.72526637341;55309.170362444595;55448.44551554433;55451.72274138604;55487.72256138694;1184.7452797648548;1211.8424604801319;1253.6677780388204;1281.2568710148091;1298.5455090718362;29665.5550166752;31918.52122218215;32090.51864221992;32092.5186122213;32350.514742279356;41077;41117.79441102775;41256.79371603123;41325.38011929763;41344;274704;275243;275563;276107;276523;26558.468830623668;27853.99896903103;27887.16338509848;28375.71624283731;28741.856290718413;44417;45438.318425222984;45525;45623.54376456193;45695.543044570455;40836.59163408328;41929.37105943474;42550.57449425466;43076.35385469158;43879.78060109679;38436.61563384442;38699.51861793766;39206.411903820896;39268.80365598268;40043.599564003984;39392.80303598464;39545.406818897165;39992.80003599964;40038.79980600078;40851.591484084776;32766.836165819972;34792;35021.124471887386;35167.648323516434;35649;27317.69952023561;27703.168904932885;27722.584161237195;28111;28118.71881281161 19:33:59 INFO - PROCESS | 14211 | |2;jquery.html;333.5613668026546;341.95554577904886;356.8750937171989;357.2301689858355;375.9567649720283;14192.36134373953;14195.503157389507;15198.392064317428;15577.29902154403;19194.42416727497;17795.91102044488;18307;18376.44870653879;19008.2396704132;19189.616207675874;5129.435762066169;5548.195511650808;5553.99999999998;5579.330480342364;5589.301337332833;5301.787928482875;5464.3442786865435;5479.123340265558;5492.313460817398;5513;5451.127819548873;5463.7814487420455;5469.699166545838;5473.28847249857;5478.534324582415;5164.173732202867;5430.67415955044;5465.672059676413;5472.644278121909;5480.177973303997;5268.5521730652945;5292.814751483718;5308.071087559701;5317.096093664048;5342.2253773202665;12151.392430378446;12173.756524869454;12189.329586872807;12280.201786883825;12282.570110046196;1937.0702063009694;2073.2536286936693;2121.4908421978766;2367;2481.404462928884;10150.644727434577;13518.32408379587;13727.382267797973;13841.515546955809;14154.50459233932;1822.589917268604;1856.832885040353;1935.1775495414533;1955.5697746495748;1965.557749506364;72024;72462.27537724609;73484;76028.23971760322;85528;9801.9019809801;10739.248252622398;10764.300320479144;10767.246292759588;11350.262232954996;14681.412743490355;14836.184009879344;14873.92563037178;14887.330070146869;14911.328990195467;7191.856162876713;7367.5579465231185;7639.923600764032;7724.729634462767;7770.378369730521;7066.434685225169;7090.716371345192;7273.272672732684;7352.77941661751;7382.446316526282;4452.888677783081;4555.863324100283;4559.908801823945;4623.075384923029;4809.422869255712;1835.8255965683238;1837.660032893919;1854.925802967893;1885.9905700471684;1945.5038965063818;883.8409086364516;901.977450563728;922.4557511068501;929.9442033478012;946.6355453150586;19467.221311147678;19694.90152549228;19807.801921980885;19822;19830.90084549597;941.8916824565125;945.2343601682659;945.3760518058049;965.8502932045544;974.907383798538;10167.796644067077;11021.504032318566;11150.832737508943;11160.209947513122;11176.441177941071;386291;391056;398836;425451;428165;86532.56733716291;87958.56020719983;89928.55035724779;90261.54869225612;91069.54465227763;990.8067926754358;999.9300048996646;1001.7645853224486;1005.703317521333;1016.4307987527009;16973;17101.552009025334;17539;17717.46847594574;17789;28815.694744420816;38161.427578586896;41800.3729944045;42825.571744282155;43112;55729;56377.436225638856;56666.433335666115;57419.712901435225;57802.13296800636;7631.427642926914;7711.305982461606;7743.419243556643;7772.805679858049;7850;9448.48033358172;13023.739525209254;13155.934220328838;13238.933805330911;13331.866681333062;11248.94375528117;11409.486573104065;11657.125715571197;11678.24091434054;11846.11154163424;11225.214235003472;11239.831402528805;11598.362090085126;11618.477168527268;11689.298642081503;11611.825822612498;11667.124965627781;11781.175317727677;11911.047116230855;11990.460429280529;7358.96320518394;7531.435142364235;7584.962075189809;7787.4548781584745;8530.317574594143;10426.165906727596;11373.829392559284;11447.141464390037;11619.244749091282;11628.883711163118 19:33:59 INFO - PROCESS | 14211 | |3;mootools.html;1280.7694614969314;1423.5693128405953;1450.6808502129531;1564.827868934417;1720.819313972033;7052.541584796991;7642.312191902728;7897.407694422913;7915.287624113836;8073.91926080739;7911.36709063275;7947.284744373005;7987.680492780281;7992.240737129978;7997.280244777969;2103.547737236494;2132.2110818996994;2140.721706178195;2141.4004078857943;2141.550274442361;2058.475088852348;2107.8524503284775;2118.4597927528457;2128.797764212405;2144.378130342199;2078.646630072891;2116.904739286736;2133.4666333416644;2133.765285818559;2160.935171944844;2098.412444515538;2099.3939636178334;2102.432343267317;2105.7894210578975;2109.1457959526265;2038.8674736142252;2090.780468050848;2096.790320967906;2098.097817938286;2115.968260476094;7825.843483130362;7833.921660783376;7838.490498117604;7890.1715319891155;8097.635606397726;4694.2958556216845;4826.95173048272;4853.95146048542;4857.247126695333;4858.659893807435;2982.7613790896676;3153.7634677399287;3167.9683203167906;3188.872445102193;3223.919402014945;1060.9363438193734;1067.1836045425257;1068.150820098016;1084.0839490630406;1102.2725001499052;10613.5223914924;10617.097546708539;10689.572417103229;10701.732456688567;10733.248672592921;3831.348670725983;3859.1895701902913;3988.3818008208773;4035.7376770509823;4043.7169398142437;8486.32109431244;8539.06070332263;8553.272971797467;8565.61454734526;8584;4679.134360143385;4682.508336624674;4686.109639168547;4692.6245900327895;4693.718376897329;3805.3911374179997;3880.4567360569545;3913.2369188008065;4438.5561443856;4440.822367105279;3167.2081979505124;3491.231928975672;3567.518385018041;3588.300281445145;3595.460680897886;1021.1473419694638;1040.105509262034;1051.3166441812882;1058.1640504001753;1080.783843231357;929.4469790474657;939.9765005874908;943.3490891284991;952.4190243951184;970.3498655900563;5463.071277882769;5481.571696681701;5491.588130890199;5539.639923404966;5842.707864606753;399.38694104549955;403.00457869063365;412.23736088236524;421.2060266397862;421.80807732481645;3911.8630847920185;3964.841406343714;3977.5823538528616;3998.4605926718423;4011.4584531088512;9274.536273186313;9590.712278631652;9601.47191904452;9717.951410243046;9723.854142187873;9602.135807777195;9652.131308182157;9662.806743865083;9695.127438530566;9718.75703107428;7371.336579707745;7441.404687624977;7443.2184620615135;7477.439192060618;7502.3622992046285;5326.840194794162;5419.810306639249;5562.082256427644;5625.46558076982;5705.885882282414;8639.352048596254;8723.563821808757;8733.344999124964;8813.074627164055;8843.098733772269;9033.548322583712;9036.864447033167;9100.453972761656;9118.22495087925;9118.635254589743;6163.3836616338;6371.076193951758;6485.6108633482145;6702.061711360316;6722.663866806738;7710.807229819299;7755.030621172354;7755.92244077552;7778.766637000899;7781.182975787688;6795.354441328066;6819.079424277659;6840.144981877265;6929.584224946318;7039.507234493741;6781.660916954232;6830.487713421613;6836.589804611739;6857.382835544825;6864.519483636098;6340.365963403623;6345.650989195638;6384.585001974857;6385.553011289351;6420.101185834081;4692;4781.713097214179;4839.080574690797;4862.100511405401;4948;4945.332380128781;4952.133376659142;4977.552020318189;4990.850274491771;5038.294638750504 19:33:59 INFO - PROCESS | 14211 | |4;prototype.html;288.55274324796574;293.8193011298051;302.5582649331975;304.69073890001664;306.2619087997924;5110.565601923841;5226.451222621627;5250.343707036621;5278.89442211156;5323.1749078892835;5076.416212135606;5173.534381905628;5187.922181167285;5252.894942101165;5286.2070689396605;4078.3270760324513;4081.9387709184384;4105.240530501852;4112.712110152291;4122.670186385097;3798.3163030654473;3977.224441233946;4063.1264278180183;4109.773962432065;4131.380292956065;3960.4851369321946;3970.1265721541213;3992.441058251847;3992.983543310624;4010.7794071326066;3984.485895359759;3985.0871581640686;4000.3399439092514;4008.3386241270155;4031.3751368537633;3504.8072356020407;3505.5092287079574;3522.894313170609;3523;3525.1010992196825;4927.827526036572;5127.154019586764;5137.897242055175;5153.252778347156;5163.586913046947;4565.56627120423;4583.518730533279;4594.540545945412;4601.516840731709;4601.815927362902;5436.238926550286;5449.155380915964;5457.645253058538;5459.890802183934;5470.91793623096;3701.574893665931;3793.9620603793883;3797.025546715692;3829.9042523936846;3845.8653947111998;5664.2636457260705;5687.914681279784;5692.487676109128;5697.544196464273;5698.202251684767;3911.374180131222;3916.2559113768293;3917.059905622687;3919.7060220483577;3945.612904192922;3870.1872606752336;3956.2680904032845;3962.881113566598;3978.8806335809973;3992.2215168041953;4563.977180114078;4580.839670611513;4584.587387135174;4600.263957766741;4609.446866376056;5469.453054694578;5469.589780766459;5469.863253418617;5482.122860342326;5490.6431081979545;1288.904431233463;1325.7945018522144;1337.2310921220337;1354.525915929417;1364.1883079567642;893.3300024981264;908.4685459006423;921.318224513855;927.9628814847465;930.1767935377239;5251.553617942518;5258.947410525922;5272.393674727378;5273.868153296198;5277.129273669878;5578.442155784389;5585.162225666182;5599.328080630269;5604.299462567179;5604.859878502988;4980.452150263468;5152.3044389007;5220.251215842659;5275.287836142148;5279.208118782213;2569.7301783312855;2571.9357016074746;2595.260350800013;2597.5713357653217;2601;4994.600431965434;4995;4998.225275082368;5022.397312322545;5024.773885175176;4605.69452999264;4939.468280179617;4947.936193718368;5013.523715247045;5023.321851550067;4982.302477653059;5061.443241243386;5081;5084.77118529667;5086.694798312114;4830.541098595628;4837.975810120927;4847.2729090636685;4850.442199147144;4900.803967841246;4830.830920917751;4845.5881250094135;5173.430922598586;5566.190987928859;5614.6631202128;5858.648481091148;5867.471927526543;5870.5010074142465;5873.530117590497;5909.911351329648;3878.2825177342283;3880.631340022693;3890.3191941409573;3897.4738410314244;3917.942155618024;5362.276092727588;5413.7834486620095;5620.178278770475;5682.914756278742;5734.885302294014;5474.315710536183;5475.315585551806;5632.127020311858;5670.716464176857;5683.959081891168;5594.804181853616;5614.782161046282;5620;5644.6330988485615;5653.971730141488;5279.815206467755;5518.889622207614;5526.889462210814;5578.246936663499;5607.971960140173;5565.387807341108;5572.773989722255;5606.355269143937;5607.831765047055;5633.521150702236;5516.420775818642;5519.503244707996;5524.900537795612;5536.501714845684;5537.224788529528 19:33:59 INFO - PROCESS | 14211 | |5;yui.html;669.4176066821863;722.3895808042204;739.7336958694866;745.2026331824947;862.9084208476279;14946.25268736563;16536.75194872078;16687.415940442086;16790.328386864512;16809.075500847448;15233.238338083107;15515.767263491029;15532.45636402726;15541.378344866192;15545.844541554581;670.9630970296631;808.8948436703221;831.4138532334689;834.7704381295162;835.3859912963967;690.6615758278433;809.9676012959475;817.8854960305562;826.7519744076753;833.1127349372929;862.762740246431;863.8401895649293;864.9221570058694;865.1262225152578;865.126222515261;694.6769752065314;857.9442336248186;860.152749541704;860.6127242740761;861.6294993152942;521.5957632834545;603.3544107804651;609.9908501372483;615.6244690738646;618.1407843098098;14523.419063237458;14541.418343266256;14568.562943111723;14571.125732456087;14575.125492470379;13817.723645527034;14175.929120354436;14565.854341456661;14695.632609184855;15011.699766004727;13040.217586944813;13180.53868114621;13208.141470804367;13425.66435839102;13477.19136851792;4347.934780978288;4361.454818147731;4460.821567137311;4461.687681862271;4491.438570178728;76108.2561836395;76110.6194469024;76491.61754191249;76508.61745691292;76635.61682191554;10837.620683276047;11066.114710823114;11144.05275551571;11222.382768947624;11518.654440366803;19401.611967760848;20161.899190503955;20171.495712607008;20789.1684332625;20808.167673293203;8431.77169234732;8742.388032837767;8755.0807165248;8803.987541432689;8817.16236957488;4664.416947881515;4675.509071547439;4754.595859351994;4761.262004389325;4835.95164048355;3561.0919215600375;3672.540932383452;3676.852925882935;3685.74199806011;3688.5389326334207;642.6497558830355;677.6984242012257;684.551618689759;687.3779229797042;697.6965020216222;713.5468977199515;728.9562626242337;729.3727394440776;737.376916505552;779.185750890321;9299.395539289924;9925.156361709336;10348.637797677045;10434.269601127848;10502.894971050191;661.3882159002903;714;746.7125156814666;759.4380158682535;775.2712450296704;4463.799129039201;4600.838970636011;4643;4678.532146785295;4769.642276829182;75415.62292188503;104145;117899;119747;120261.39869300598;99102;100158;103417;104471.4776426113;106496.9350306487;69855.99999999898;89510.55244723735;91009.54495227613;91897;92168.53915730378;9156.22172115351;9790.363626364264;10446.134930075921;10448.843267350843;10701.678949631523;45663.77518388168;46971;47166.52833471621;48370.274445882635;49065.50934490752;65338;70279.64860175666;70948.64525677338;71607.64196179195;71969;12820;12827.871721282667;12848;12858.164219325714;13232.735345293233;14230.715385692021;14683.48607798722;14704;14793.186374749492;15442.536723898302;13548.32258387057;13770.93114534461;14181.361838717075;14921.104733716013;15081.321340539922;13219.537316193888;13343.266120363473;13457.259850708306;13773.793393099311;14237.50168744089;13163.276019819003;13906.860931390556;14470.059446135967;14486.637834054232;14606;11173.162012848907;11410.315381077162;11568.24806387582;11825.526978920747;12184.939075304566;10511.737206569896;11662.88337116618;11697.387831736321;11719.163644718725;11925.403729813648 19:33:59 INFO - PROCESS | 14211 | __end_tp_report 19:33:59 INFO - PROCESS | 14211 | __start_cc_report 19:33:59 INFO - PROCESS | 14211 | _x_x_mozilla_cycle_collect,1142 19:33:59 INFO - PROCESS | 14211 | __end_cc_report 19:33:59 INFO - PROCESS | 14211 | __startTimestamp1476758039917__endTimestamp 19:33:59 INFO - PROCESS | 14211 | 19:33:59 INFO - PROCESS | 14211 | ------- Summary: start ------- 19:33:59 INFO - PROCESS | 14211 | Number of tests: 6 19:33:59 INFO - PROCESS | 14211 | 19:33:59 INFO - PROCESS | 14211 | [#0] dojo.html Cycles:165 Average:5166.63 Median:5337.20 stddev:577.07 (10.8%) stddev-sans-first:553.05 19:33:59 INFO - PROCESS | 14211 | Values: 2991.8 3017.0 3047.5 3068.5 3072.3 5048.8 5139.7 5200.2 5298.4 5380.1 5133.0 5158.5 5162.7 5164.0 5182.4 4634.6 4681.6 4697.3 4727.9 4738.5 4762.4 4764.7 4773.0 4797.2 4801.8 4715.8 4719.6 4741.2 4777.2 4787.4 4823.5 4827.2 4835.2 4845.8 4885.7 4611.5 4643.2 4728.2 4739.6 4792.6 5251.2 5255.8 5262.4 5276.8 5353.7 5563.4 5629.3 5631.2 5639.0 5640.7 5380.4 5505.0 5616.8 5702.6 5760.7 5242.3 5243.6 5256.3 5303.0 5303.6 5685.4 5687.3 5700.8 5705.1 5708.9 5247.2 5336.2 5536.4 5541.5 5609.7 5469.0 5519.8 5533.2 5566.9 5599.4 5466.6 5512.4 5514.3 5519.8 5526.3 5350.7 5481.3 5539.4 5543.2 5597.6 4173.8 4218.1 4219.7 4221.6 4223.3 3792.0 3815.3 3821.8 3823.9 3842.3 5270.5 5318.4 5330.1 5330.2 5335.8 5594.9 5605.5 5607.0 5608.4 5609.2 5093.0 5219.3 5277.4 5289.2 5289.6 4713.8 4748.0 4765.0 4769.8 4769.9 5648.1 5657.0 5658.7 5667.3 5667.3 5449.5 5479.1 5490.2 5494.8 5498.8 5624.2 5634.6 5645.5 5645.8 5655.5 5431.5 5449.4 5456.5 5457.6 5459.1 5535.5 5535.9 5540.8 5547.4 5554.0 5473.9 5475.6 5500.7 5529.1 5538.4 5522.1 5522.3 5522.6 5530.1 5615.1 5263.3 5297.3 5337.2 5351.0 5515.3 5415.1 5446.2 5448.6 5461.5 5513.0 5250.7 5270.4 5286.3 5292.5 5300.3 19:33:59 INFO - PROCESS | 14211 | 19:33:59 INFO - PROCESS | 14211 | [#1] ext.html Cycles:180 Average:50017.44 Median:19079.81 stddev:93467.14 (489.9%) stddev-sans-first:93655.54 19:33:59 INFO - PROCESS | 14211 | Values: 549.2 574.4 600.4 611.6 625.2 30272.2 40635.6 41530.0 41602.4 41692.0 43275.0 43516.0 43576.0 43656.8 43803.4 8013.5 8765.3 8897.5 8918.1 8924.6 8156.1 10360.7 10606.7 10608.8 10977.1 10691.9 10741.8 10770.3 10774.9 10784.7 10582.9 10641.3 10655.7 10663.3 10667.8 10136.7 10220.9 10255.3 10311.7 10332.7 40240.4 40535.8 40540.0 40886.2 41004.8 3329.5 3367.6 3508.7 3599.7 3765.2 30048.4 30660.4 30667.7 30733.0 30798.2 4033.9 4084.8 4257.1 4307.2 4391.0 297626.0 299119.0 299199.0 301389.0 301423.0 32730.0 33574.8 54613.2 54750.0 54932.5 34847.7 35044.5 35164.0 35188.5 35207.6 14326.2 14396.5 14431.0 14435.9 14442.4 10780.1 10874.1 11169.3 11243.6 11263.8 7893.8 7916.3 7970.2 7986.7 8042.6 3108.3 3134.7 3147.7 3147.9 3164.4 863.7 926.4 953.8 964.0 1037.8 29932.7 31262.7 31555.5 31705.4 32178.2 1029.6 1049.9 1052.1 1098.4 1191.6 16078.5 16737.7 16825.8 16907.4 16925.2 451423.0 458115.0 458959.0 460183.0 461271.0 54946.7 55309.2 55448.4 55451.7 55487.7 1184.7 1211.8 1253.7 1281.3 1298.5 29665.6 31918.5 32090.5 32092.5 32350.5 41077.0 41117.8 41256.8 41325.4 41344.0 274704.0 275243.0 275563.0 276107.0 276523.0 26558.5 27854.0 27887.2 28375.7 28741.9 44417.0 45438.3 45525.0 45623.5 45695.5 40836.6 41929.4 42550.6 43076.4 43879.8 38436.6 38699.5 39206.4 39268.8 40043.6 39392.8 39545.4 39992.8 40038.8 40851.6 32766.8 34792.0 35021.1 35167.6 35649.0 27317.7 27703.2 27722.6 28111.0 28118.7 19:33:59 INFO - PROCESS | 14211 | 19:33:59 INFO - PROCESS | 14211 | [#2] jquery.html Cycles:180 Average:25822.76 Median:366.59 stddev:67430.54 (18393.8%) stddev-sans-first:67592.54 19:33:59 INFO - PROCESS | 14211 | Values: 333.6 342.0 356.9 357.2 376.0 14192.4 14195.5 15198.4 15577.3 19194.4 17795.9 18307.0 18376.4 19008.2 19189.6 5129.4 5548.2 5554.0 5579.3 5589.3 5301.8 5464.3 5479.1 5492.3 5513.0 5451.1 5463.8 5469.7 5473.3 5478.5 5164.2 5430.7 5465.7 5472.6 5480.2 5268.6 5292.8 5308.1 5317.1 5342.2 12151.4 12173.8 12189.3 12280.2 12282.6 1937.1 2073.3 2121.5 2367.0 2481.4 10150.6 13518.3 13727.4 13841.5 14154.5 1822.6 1856.8 1935.2 1955.6 1965.6 72024.0 72462.3 73484.0 76028.2 85528.0 9801.9 10739.2 10764.3 10767.2 11350.3 14681.4 14836.2 14873.9 14887.3 14911.3 7191.9 7367.6 7639.9 7724.7 7770.4 7066.4 7090.7 7273.3 7352.8 7382.4 4452.9 4555.9 4559.9 4623.1 4809.4 1835.8 1837.7 1854.9 1886.0 1945.5 883.8 902.0 922.5 929.9 946.6 19467.2 19694.9 19807.8 19822.0 19830.9 941.9 945.2 945.4 965.9 974.9 10167.8 11021.5 11150.8 11160.2 11176.4 386291.0 391056.0 398836.0 425451.0 428165.0 86532.6 87958.6 89928.6 90261.5 91069.5 990.8 999.9 1001.8 1005.7 1016.4 16973.0 17101.6 17539.0 17717.5 17789.0 28815.7 38161.4 41800.4 42825.6 43112.0 55729.0 56377.4 56666.4 57419.7 57802.1 7631.4 7711.3 7743.4 7772.8 7850.0 9448.5 13023.7 13155.9 13238.9 13331.9 11248.9 11409.5 11657.1 11678.2 11846.1 11225.2 11239.8 11598.4 11618.5 11689.3 11611.8 11667.1 11781.2 11911.0 11990.5 7359.0 7531.4 7585.0 7787.5 8530.3 10426.2 11373.8 11447.1 11619.2 11628.9 19:33:59 INFO - PROCESS | 14211 | 19:33:59 INFO - PROCESS | 14211 | [#3] mootools.html Cycles:180 Average:5173.46 Median:4950.07 stddev:2888.80 (58.4%) stddev-sans-first:2882.09 19:33:59 INFO - PROCESS | 14211 | Values: 1280.8 1423.6 1450.7 1564.8 1720.8 7052.5 7642.3 7897.4 7915.3 8073.9 7911.4 7947.3 7987.7 7992.2 7997.3 2103.5 2132.2 2140.7 2141.4 2141.6 2058.5 2107.9 2118.5 2128.8 2144.4 2078.6 2116.9 2133.5 2133.8 2160.9 2098.4 2099.4 2102.4 2105.8 2109.1 2038.9 2090.8 2096.8 2098.1 2116.0 7825.8 7833.9 7838.5 7890.2 8097.6 4694.3 4827.0 4854.0 4857.2 4858.7 2982.8 3153.8 3168.0 3188.9 3223.9 1060.9 1067.2 1068.2 1084.1 1102.3 10613.5 10617.1 10689.6 10701.7 10733.2 3831.3 3859.2 3988.4 4035.7 4043.7 8486.3 8539.1 8553.3 8565.6 8584.0 4679.1 4682.5 4686.1 4692.6 4693.7 3805.4 3880.5 3913.2 4438.6 4440.8 3167.2 3491.2 3567.5 3588.3 3595.5 1021.1 1040.1 1051.3 1058.2 1080.8 929.4 940.0 943.3 952.4 970.3 5463.1 5481.6 5491.6 5539.6 5842.7 399.4 403.0 412.2 421.2 421.8 3911.9 3964.8 3977.6 3998.5 4011.5 9274.5 9590.7 9601.5 9718.0 9723.9 9602.1 9652.1 9662.8 9695.1 9718.8 7371.3 7441.4 7443.2 7477.4 7502.4 5326.8 5419.8 5562.1 5625.5 5705.9 8639.4 8723.6 8733.3 8813.1 8843.1 9033.5 9036.9 9100.5 9118.2 9118.6 6163.4 6371.1 6485.6 6702.1 6722.7 7710.8 7755.0 7755.9 7778.8 7781.2 6795.4 6819.1 6840.1 6929.6 7039.5 6781.7 6830.5 6836.6 6857.4 6864.5 6340.4 6345.7 6384.6 6385.6 6420.1 4692.0 4781.7 4839.1 4862.1 4948.0 4945.3 4952.1 4977.6 4990.9 5038.3 19:33:59 INFO - PROCESS | 14211 | 19:33:59 INFO - PROCESS | 14211 | [#4] prototype.html Cycles:180 Average:4500.04 Median:5068.93 stddev:1345.52 (26.5%) stddev-sans-first:1311.63 19:33:59 INFO - PROCESS | 14211 | Values: 288.6 293.8 302.6 304.7 306.3 5110.6 5226.5 5250.3 5278.9 5323.2 5076.4 5173.5 5187.9 5252.9 5286.2 4078.3 4081.9 4105.2 4112.7 4122.7 3798.3 3977.2 4063.1 4109.8 4131.4 3960.5 3970.1 3992.4 3993.0 4010.8 3984.5 3985.1 4000.3 4008.3 4031.4 3504.8 3505.5 3522.9 3523.0 3525.1 4927.8 5127.2 5137.9 5153.3 5163.6 4565.6 4583.5 4594.5 4601.5 4601.8 5436.2 5449.2 5457.6 5459.9 5470.9 3701.6 3794.0 3797.0 3829.9 3845.9 5664.3 5687.9 5692.5 5697.5 5698.2 3911.4 3916.3 3917.1 3919.7 3945.6 3870.2 3956.3 3962.9 3978.9 3992.2 4564.0 4580.8 4584.6 4600.3 4609.4 5469.5 5469.6 5469.9 5482.1 5490.6 1288.9 1325.8 1337.2 1354.5 1364.2 893.3 908.5 921.3 928.0 930.2 5251.6 5258.9 5272.4 5273.9 5277.1 5578.4 5585.2 5599.3 5604.3 5604.9 4980.5 5152.3 5220.3 5275.3 5279.2 2569.7 2571.9 2595.3 2597.6 2601.0 4994.6 4995.0 4998.2 5022.4 5024.8 4605.7 4939.5 4947.9 5013.5 5023.3 4982.3 5061.4 5081.0 5084.8 5086.7 4830.5 4838.0 4847.3 4850.4 4900.8 4830.8 4845.6 5173.4 5566.2 5614.7 5858.6 5867.5 5870.5 5873.5 5909.9 3878.3 3880.6 3890.3 3897.5 3917.9 5362.3 5413.8 5620.2 5682.9 5734.9 5474.3 5475.3 5632.1 5670.7 5684.0 5594.8 5614.8 5620.0 5644.6 5654.0 5279.8 5518.9 5526.9 5578.2 5608.0 5565.4 5572.8 5606.4 5607.8 5633.5 5516.4 5519.5 5524.9 5536.5 5537.2 19:33:59 INFO - PROCESS | 14211 | 19:33:59 INFO - PROCESS | 14211 | [#5] yui.html Cycles:180 Average:20624.63 Median:4411.14 stddev:29406.74 (666.6%) stddev-sans-first:29451.06 19:33:59 INFO - PROCESS | 14211 | Values: 669.4 722.4 739.7 745.2 862.9 14946.3 16536.8 16687.4 16790.3 16809.1 15233.2 15515.8 15532.5 15541.4 15545.8 671.0 808.9 831.4 834.8 835.4 690.7 810.0 817.9 826.8 833.1 862.8 863.8 864.9 865.1 865.1 694.7 857.9 860.2 860.6 861.6 521.6 603.4 610.0 615.6 618.1 14523.4 14541.4 14568.6 14571.1 14575.1 13817.7 14175.9 14565.9 14695.6 15011.7 13040.2 13180.5 13208.1 13425.7 13477.2 4347.9 4361.5 4460.8 4461.7 4491.4 76108.3 76110.6 76491.6 76508.6 76635.6 10837.6 11066.1 11144.1 11222.4 11518.7 19401.6 20161.9 20171.5 20789.2 20808.2 8431.8 8742.4 8755.1 8804.0 8817.2 4664.4 4675.5 4754.6 4761.3 4836.0 3561.1 3672.5 3676.9 3685.7 3688.5 642.6 677.7 684.6 687.4 697.7 713.5 729.0 729.4 737.4 779.2 9299.4 9925.2 10348.6 10434.3 10502.9 661.4 714.0 746.7 759.4 775.3 4463.8 4600.8 4643.0 4678.5 4769.6 75415.6 104145.0 117899.0 119747.0 120261.4 99102.0 100158.0 103417.0 104471.5 106496.9 69856.0 89510.6 91009.5 91897.0 92168.5 9156.2 9790.4 10446.1 10448.8 10701.7 45663.8 46971.0 47166.5 48370.3 49065.5 65338.0 70279.6 70948.6 71607.6 71969.0 12820.0 12827.9 12848.0 12858.2 13232.7 14230.7 14683.5 14704.0 14793.2 15442.5 13548.3 13770.9 14181.4 14921.1 15081.3 13219.5 13343.3 13457.3 13773.8 14237.5 13163.3 13906.9 14470.1 14486.6 14606.0 11173.2 11410.3 11568.2 11825.5 12184.9 10511.7 11662.9 11697.4 11719.2 11925.4 19:33:59 INFO - PROCESS | 14211 | -------- Summary: end -------- 19:33:59 INFO - PROCESS | 14211 | 19:34:00 INFO - TEST-INFO | 14211: exit 0 19:34:00 INFO - TEST-OK | dromaeo_css | took 1117340ms 19:34:00 INFO - TEST-START | kraken 19:34:00 INFO - operating with platform_type : linux_ 19:34:00 INFO - Initialising browser for kraken test... 19:34:00 INFO - TEST-INFO | started process 14525 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp39Wcgi/profile http://localhost:41121/getInfo.html) 19:34:04 INFO - PROCESS | 14525 | __metrics Screen width/height:1600/1200 19:34:04 INFO - PROCESS | 14525 | colorDepth:24 19:34:04 INFO - PROCESS | 14525 | Browser inner width/height: 1024/697 19:34:04 INFO - PROCESS | 14525 | __metrics 19:34:05 INFO - PROCESS | 14525 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 19:34:05 INFO - PROCESS | 14525 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 19:34:06 INFO - TEST-INFO | 14525: exit 0 19:34:06 INFO - Browser initialized. 19:34:06 INFO - Running cycle 1/1 for kraken test... 19:34:06 INFO - TEST-INFO | started process 14613 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp39Wcgi/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 19:34:18 INFO - PROCESS | 14613 | RSS: Main: 172310528 19:34:18 INFO - PROCESS | 14613 | 19:34:20 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41121/tests/kraken/driver.html?testName=audio-beat-detection) 19:34:21 INFO - PROCESS | 14613 | RSS: Main: 229105664 19:34:21 INFO - PROCESS | 14613 | 19:34:24 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41121/tests/kraken/driver.html?testName=audio-dft) 19:34:25 INFO - PROCESS | 14613 | RSS: Main: 215810048 19:34:25 INFO - PROCESS | 14613 | 19:34:28 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41121/tests/kraken/driver.html?testName=audio-fft) 19:34:28 INFO - PROCESS | 14613 | RSS: Main: 297635840 19:34:28 INFO - PROCESS | 14613 | 19:34:30 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41121/tests/kraken/driver.html?testName=audio-oscillator) 19:34:31 INFO - PROCESS | 14613 | RSS: Main: 206688256 19:34:31 INFO - PROCESS | 14613 | 19:34:33 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41121/tests/kraken/driver.html?testName=imaging-gaussian-blur) 19:34:34 INFO - PROCESS | 14613 | RSS: Main: 211386368 19:34:34 INFO - PROCESS | 14613 | 19:34:37 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41121/tests/kraken/driver.html?testName=imaging-darkroom) 19:34:37 INFO - PROCESS | 14613 | RSS: Main: 247500800 19:34:37 INFO - PROCESS | 14613 | 19:34:41 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41121/tests/kraken/driver.html?testName=imaging-desaturate) 19:34:41 INFO - PROCESS | 14613 | RSS: Main: 246800384 19:34:41 INFO - PROCESS | 14613 | 19:34:44 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41121/tests/kraken/driver.html?testName=json-parse-financial) 19:34:45 INFO - PROCESS | 14613 | RSS: Main: 246214656 19:34:45 INFO - PROCESS | 14613 | 19:34:46 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41121/tests/kraken/driver.html?testName=json-stringify-tinderbox) 19:34:47 INFO - PROCESS | 14613 | RSS: Main: 208191488 19:34:47 INFO - PROCESS | 14613 | 19:34:48 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41121/tests/kraken/driver.html?testName=stanford-crypto-aes) 19:34:49 INFO - PROCESS | 14613 | RSS: Main: 216256512 19:34:49 INFO - PROCESS | 14613 | 19:34:51 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41121/tests/kraken/driver.html?testName=stanford-crypto-ccm) 19:34:52 INFO - PROCESS | 14613 | RSS: Main: 226041856 19:34:52 INFO - PROCESS | 14613 | 19:34:54 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41121/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 19:34:55 INFO - PROCESS | 14613 | RSS: Main: 233758720 19:34:55 INFO - PROCESS | 14613 | 19:34:58 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41121/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 19:34:59 INFO - PROCESS | 14613 | RSS: Main: 230842368 19:34:59 INFO - PROCESS | 14613 | 19:35:00 INFO - PROCESS | 14613 | Cycle 1(1): loaded http://localhost:41121/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41121/tests/kraken/driver.html?testName=ai-astar) 19:35:01 INFO - PROCESS | 14613 | RSS: Main: 282664960 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | __start_tp_report 19:35:01 INFO - PROCESS | 14613 | _x_x_mozilla_page_load 19:35:01 INFO - PROCESS | 14613 | _x_x_mozilla_page_load_details 19:35:01 INFO - PROCESS | 14613 | |i|pagename|runs| 19:35:01 INFO - PROCESS | 14613 | |0;ai-astar;106;113;113;111;116;113;114;113;114;112 19:35:01 INFO - PROCESS | 14613 | |1;audio-beat-detection;145;122;123;159;125;127;128;125;182;126 19:35:01 INFO - PROCESS | 14613 | |2;audio-dft;166;162;164;163;164;165;164;164;162;163 19:35:01 INFO - PROCESS | 14613 | |3;audio-fft;76;75;77;104;77;78;78;76;107;79 19:35:01 INFO - PROCESS | 14613 | |4;audio-oscillator;85;83;119;83;84;82;103;82;84;119 19:35:01 INFO - PROCESS | 14613 | |5;imaging-gaussian-blur;117;116;116;117;117;116;116;117;119;118 19:35:01 INFO - PROCESS | 14613 | |6;imaging-darkroom;147;148;148;147;149;148;147;147;148;147 19:35:01 INFO - PROCESS | 14613 | |7;imaging-desaturate;85;85;85;85;85;85;85;86;86;84 19:35:01 INFO - PROCESS | 14613 | |8;json-parse-financial;54;54;53;53;55;54;56;55;55;55 19:35:01 INFO - PROCESS | 14613 | |9;json-stringify-tinderbox;60;61;59;60;60;60;59;60;60;59 19:35:01 INFO - PROCESS | 14613 | |10;stanford-crypto-aes;82;82;81;89;80;81;81;81;81;80 19:35:01 INFO - PROCESS | 14613 | |11;stanford-crypto-ccm;135;166;135;137;138;132;131;135;171;131 19:35:01 INFO - PROCESS | 14613 | |12;stanford-crypto-pbkdf2;178;179;170;173;179;169;173;178;170;174 19:35:01 INFO - PROCESS | 14613 | |13;stanford-crypto-sha256-iterative;70;68;68;68;68;68;67;68;69;69 19:35:01 INFO - PROCESS | 14613 | __end_tp_report 19:35:01 INFO - PROCESS | 14613 | __start_cc_report 19:35:01 INFO - PROCESS | 14613 | _x_x_mozilla_cycle_collect,1693 19:35:01 INFO - PROCESS | 14613 | __end_cc_report 19:35:01 INFO - PROCESS | 14613 | __startTimestamp1476758101020__endTimestamp 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | ------- Summary: start ------- 19:35:01 INFO - PROCESS | 14613 | Number of tests: 14 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#0] ai-astar Cycles:10 Average:112.50 Median:113.00 stddev:2.64 (2.3%) stddev-sans-first:1.39 19:35:01 INFO - PROCESS | 14613 | Values: 106.0 113.0 113.0 111.0 116.0 113.0 114.0 113.0 114.0 112.0 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#1] audio-beat-detection Cycles:10 Average:136.20 Median:127.50 stddev:19.94 (15.6%) stddev-sans-first:20.89 19:35:01 INFO - PROCESS | 14613 | Values: 145.0 122.0 123.0 159.0 125.0 127.0 128.0 125.0 182.0 126.0 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#2] audio-dft Cycles:10 Average:163.70 Median:164.00 stddev:1.25 (0.8%) stddev-sans-first:1.01 19:35:01 INFO - PROCESS | 14613 | Values: 166.0 162.0 164.0 163.0 164.0 165.0 164.0 164.0 162.0 163.0 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#3] audio-fft Cycles:10 Average:82.70 Median:77.00 stddev:12.09 (15.7%) stddev-sans-first:12.58 19:35:01 INFO - PROCESS | 14613 | Values: 76.0 75.0 77.0 104.0 77.0 78.0 78.0 76.0 107.0 79.0 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#4] audio-oscillator Cycles:10 Average:92.40 Median:83.00 stddev:15.33 (18.5%) stddev-sans-first:16.03 19:35:01 INFO - PROCESS | 14613 | Values: 85.0 83.0 119.0 83.0 84.0 82.0 103.0 82.0 84.0 119.0 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#5] imaging-gaussian-blur Cycles:10 Average:116.90 Median:117.00 stddev:0.99 (0.8%) stddev-sans-first:1.05 19:35:01 INFO - PROCESS | 14613 | Values: 117.0 116.0 116.0 117.0 117.0 116.0 116.0 117.0 119.0 118.0 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#6] imaging-darkroom Cycles:10 Average:147.60 Median:148.00 stddev:0.70 (0.5%) stddev-sans-first:0.71 19:35:01 INFO - PROCESS | 14613 | Values: 147.0 148.0 148.0 147.0 149.0 148.0 147.0 147.0 148.0 147.0 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#7] imaging-desaturate Cycles:10 Average:85.10 Median:85.00 stddev:0.57 (0.7%) stddev-sans-first:0.60 19:35:01 INFO - PROCESS | 14613 | Values: 85.0 85.0 85.0 85.0 85.0 85.0 85.0 86.0 86.0 84.0 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#8] json-parse-financial Cycles:10 Average:54.40 Median:55.00 stddev:0.97 (1.8%) stddev-sans-first:1.01 19:35:01 INFO - PROCESS | 14613 | Values: 54.0 54.0 53.0 53.0 55.0 54.0 56.0 55.0 55.0 55.0 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#9] json-stringify-tinderbox Cycles:10 Average:59.80 Median:60.00 stddev:0.63 (1.1%) stddev-sans-first:0.67 19:35:01 INFO - PROCESS | 14613 | Values: 60.0 61.0 59.0 60.0 60.0 60.0 59.0 60.0 60.0 59.0 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#10] stanford-crypto-aes Cycles:10 Average:81.80 Median:81.00 stddev:2.62 (3.2%) stddev-sans-first:2.77 19:35:01 INFO - PROCESS | 14613 | Values: 82.0 82.0 81.0 89.0 80.0 81.0 81.0 81.0 81.0 80.0 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#11] stanford-crypto-ccm Cycles:10 Average:141.10 Median:136.00 stddev:14.68 (10.8%) stddev-sans-first:15.40 19:35:01 INFO - PROCESS | 14613 | Values: 135.0 166.0 135.0 137.0 138.0 132.0 131.0 135.0 171.0 131.0 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:174.30 Median:176.00 stddev:3.95 (2.2%) stddev-sans-first:3.95 19:35:01 INFO - PROCESS | 14613 | Values: 178.0 179.0 170.0 173.0 179.0 169.0 173.0 178.0 170.0 174.0 19:35:01 INFO - PROCESS | 14613 | 19:35:01 INFO - PROCESS | 14613 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.30 Median:68.00 stddev:0.82 (1.2%) stddev-sans-first:0.60 19:35:01 INFO - PROCESS | 14613 | Values: 70.0 68.0 68.0 68.0 68.0 68.0 67.0 68.0 69.0 69.0 19:35:01 INFO - PROCESS | 14613 | -------- Summary: end -------- 19:35:01 INFO - PROCESS | 14613 | 19:35:02 INFO - TEST-INFO | 14613: exit 0 19:35:02 INFO - TEST-OK | kraken | took 61415ms 19:35:02 INFO - SUITE-END | took 1178s 19:35:02 INFO - Completed test suite (00:19:39) 19:35:02 INFO - javascript benchmark 19:35:02 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2991.8354490503025, 3016.969830301696, 3047.5276332168514, 3068.509038553832, 3072.2626569623285, 5048.848534543969, 5139.691618502892, 5200.219967004947, 5298.417174110849, 5380.139177731558, 5132.974335128329, 5158.484151584839, 5162.741862906859, 5163.974180129094, 5182.4299327073995, 4634.582887540129, 4681.555252251031, 4697.342372067913, 4727.858164255061, 4738.502457241992, 4762.380890484233, 4764.690295130806, 4772.976135119319, 4797.184478638623, 4801.831935882227, 4715.834945776898, 4719.6460265480055, 4741.170295198343, 4777.187878060738, 4787.353707249512, 4823.541763532458, 4827.227643577028, 4835.178019736618, 4845.806167753286, 4885.658003939726, 4611.515790841981, 4643.16423043852, 4728.172569800306, 4739.597134243593, 4792.568668819823, 5251.159814429673, 5255.76349064293, 5262.368515778093, 5276.7889284428575, 5353.732313384354, 5563.388027316992, 5629.324481062258, 5631.239782629334, 5639.0, 5640.689762063085, 5380.4350543192795, 5505.0, 5616.803411880605, 5702.572307076985, 5760.74076666551, 5242.344706911636, 5243.554297884646, 5256.342957130359, 5303.04545181871, 5303.575713942914, 5685.431456854364, 5687.3459552152035, 5700.800471983461, 5705.144228365778, 5708.857278568069, 5247.18668606359, 5336.226247194135, 5536.446355364512, 5541.473560011793, 5609.66342019472, 5469.042917489503, 5519.806806761744, 5533.170024496278, 5566.860828479321, 5599.44005599445, 5466.562674985991, 5512.366077901012, 5514.310711161105, 5519.806806761744, 5526.253955715927, 5350.678959262456, 5481.314835645544, 5539.362973258047, 5543.223948647193, 5597.580181486404, 4173.791310434466, 4218.135282267128, 4219.725717828332, 4221.5567365426805, 4223.345381465878, 3791.981040094837, 3815.2560250751394, 3821.7898015608853, 3823.9426408603895, 3842.3083844908183, 5270.5256526912, 5318.44156363584, 5330.093884039723, 5330.200469929541, 5335.839924802262, 5594.888102237933, 5605.523530499871, 5607.046802043662, 5608.355039170548, 5609.15862620602, 5093.0, 5219.347581552306, 5277.445868183862, 5289.20661900718, 5289.603279754034, 4713.787879545429, 4747.976260118747, 4764.952350476451, 4769.76151192439, 4769.928451073237, 5648.068068768689, 5657.038303488417, 5658.660480371191, 5667.319921609434, 5667.348254950569, 5449.509544141047, 5479.123340265538, 5490.231367608458, 5494.80768173128, 5498.835034948958, 5624.212610234488, 5634.6337488063145, 5645.548356131581, 5645.802396916089, 5655.4910058094965, 5431.4840090191365, 5449.427810080043, 5456.48163424474, 5457.5633949283165, 5459.126539753779, 5535.501804837584, 5535.916961245665, 5540.833774986757, 5547.389787123494, 5553.972230138985, 5473.863153421196, 5475.616706830484, 5500.724963751716, 5529.115341545334, 5538.446155384429, 5522.116461366162, 5522.2544956431975, 5522.641028333145, 5530.059889818821, 5615.073512870494, 5263.289455923555, 5297.2583838263445, 5337.199420086863, 5351.010063138332, 5515.338159420895, 5415.133578627559, 5446.183072538993, 5448.56411487088, 5461.508464238238, 5513.007658621486, 5250.684958902478, 5270.446603106619, 5286.259923610621, 5292.52367286946, 5300.257963884982], "value": 5128.329105629785, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [549.2127175324525, 574.43992107695, 600.4355905448879, 611.5566214494489, 625.1622825413945, 30272.243193920163, 40635.593644063585, 41530.0, 41602.37596436056, 41691.95770105745, 43275.0, 43516.0, 43576.0, 43656.78171609146, 43803.37179769216, 8013.47912385696, 8765.254953328958, 8897.466152030898, 8918.063603321654, 8924.598393072294, 8156.143604921487, 10360.740981475486, 10606.734831629194, 10608.840867386956, 10977.06694930932, 10691.946540267289, 10741.83887241692, 10770.29993050453, 10774.946125269362, 10784.73038174044, 10582.894171058268, 10641.308314959502, 10655.680329590046, 10663.306885052525, 10667.83998240027, 10136.732908386452, 10220.89779102207, 10255.33340332876, 10311.742206444824, 10332.741681457948, 40240.396394054114, 40535.797321013204, 40540.0, 40886.1822763546, 41004.79497602493, 3329.5338652588657, 3367.6127245366606, 3508.7193024557973, 3599.748017638766, 3765.2093060457337, 30048.39903201924, 30660.386792264253, 30667.693323066705, 30733.0, 30798.23004424885, 4033.899152521181, 4084.8366065357645, 4257.127288905798, 4307.224699554079, 4390.978045109786, 297626.0, 299119.0, 299199.0, 301389.0, 301423.0, 32730.0, 33574.832125839705, 54613.180802288, 54750.0, 54932.450675493536, 34847.65152348444, 35044.47433288502, 35164.0, 35188.47217291692, 35207.64792352095, 14326.212058336683, 14396.496122635657, 14431.0, 14435.92782036083, 14442.350094245785, 10780.083692886035, 10874.075703565286, 11169.273997190157, 11243.550257989753, 11263.831042534368, 7893.842123157505, 7916.327112195413, 7970.242826931432, 7986.720464783821, 8042.638081286356, 3108.2695566541843, 3134.7492200623897, 3147.653758086609, 3147.8583463744185, 3164.3829453256394, 863.6933888469503, 926.4487629860222, 953.7520244736419, 963.9759006024906, 1037.7509397744639, 29932.700672993426, 31262.687373125977, 31555.526667100014, 31705.365892682017, 32178.19554511156, 1029.577873072052, 1049.8740151181908, 1052.1267348101057, 1098.3903933316926, 1191.5710344276054, 16078.517644470685, 16737.748933766004, 16825.831741682672, 16907.408240711517, 16925.23836427364, 451423.0, 458115.0, 458959.0, 460183.0, 461271.0, 54946.72526637341, 55309.170362444595, 55448.44551554433, 55451.72274138604, 55487.72256138694, 1184.7452797648548, 1211.8424604801319, 1253.6677780388204, 1281.2568710148091, 1298.5455090718362, 29665.5550166752, 31918.52122218215, 32090.51864221992, 32092.5186122213, 32350.514742279356, 41077.0, 41117.79441102775, 41256.79371603123, 41325.38011929763, 41344.0, 274704.0, 275243.0, 275563.0, 276107.0, 276523.0, 26558.468830623668, 27853.99896903103, 27887.16338509848, 28375.71624283731, 28741.856290718413, 44417.0, 45438.318425222984, 45525.0, 45623.54376456193, 45695.543044570455, 40836.59163408328, 41929.37105943474, 42550.57449425466, 43076.35385469158, 43879.78060109679, 38436.61563384442, 38699.51861793766, 39206.411903820896, 39268.80365598268, 40043.599564003984, 39392.80303598464, 39545.406818897165, 39992.80003599964, 40038.79980600078, 40851.591484084776, 32766.836165819972, 34792.0, 35021.124471887386, 35167.648323516434, 35649.0, 27317.69952023561, 27703.168904932885, 27722.584161237195, 28111.0, 28118.71881281161], "value": 18088.703790329215, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [333.5613668026546, 341.95554577904886, 356.8750937171989, 357.2301689858355, 375.9567649720283, 14192.36134373953, 14195.503157389507, 15198.392064317428, 15577.29902154403, 19194.42416727497, 17795.91102044488, 18307.0, 18376.44870653879, 19008.2396704132, 19189.616207675874, 5129.435762066169, 5548.195511650808, 5553.99999999998, 5579.330480342364, 5589.301337332833, 5301.787928482875, 5464.3442786865435, 5479.123340265558, 5492.313460817398, 5513.0, 5451.127819548873, 5463.7814487420455, 5469.699166545838, 5473.28847249857, 5478.534324582415, 5164.173732202867, 5430.67415955044, 5465.672059676413, 5472.644278121909, 5480.177973303997, 5268.5521730652945, 5292.814751483718, 5308.071087559701, 5317.096093664048, 5342.2253773202665, 12151.392430378446, 12173.756524869454, 12189.329586872807, 12280.201786883825, 12282.570110046196, 1937.0702063009694, 2073.2536286936693, 2121.4908421978766, 2367.0, 2481.404462928884, 10150.644727434577, 13518.32408379587, 13727.382267797973, 13841.515546955809, 14154.50459233932, 1822.589917268604, 1856.832885040353, 1935.1775495414533, 1955.5697746495748, 1965.557749506364, 72024.0, 72462.27537724609, 73484.0, 76028.23971760322, 85528.0, 9801.9019809801, 10739.248252622398, 10764.300320479144, 10767.246292759588, 11350.262232954996, 14681.412743490355, 14836.184009879344, 14873.92563037178, 14887.330070146869, 14911.328990195467, 7191.856162876713, 7367.5579465231185, 7639.923600764032, 7724.729634462767, 7770.378369730521, 7066.434685225169, 7090.716371345192, 7273.272672732684, 7352.77941661751, 7382.446316526282, 4452.888677783081, 4555.863324100283, 4559.908801823945, 4623.075384923029, 4809.422869255712, 1835.8255965683238, 1837.660032893919, 1854.925802967893, 1885.9905700471684, 1945.5038965063818, 883.8409086364516, 901.977450563728, 922.4557511068501, 929.9442033478012, 946.6355453150586, 19467.221311147678, 19694.90152549228, 19807.801921980885, 19822.0, 19830.90084549597, 941.8916824565125, 945.2343601682659, 945.3760518058049, 965.8502932045544, 974.907383798538, 10167.796644067077, 11021.504032318566, 11150.832737508943, 11160.209947513122, 11176.441177941071, 386291.0, 391056.0, 398836.0, 425451.0, 428165.0, 86532.56733716291, 87958.56020719983, 89928.55035724779, 90261.54869225612, 91069.54465227763, 990.8067926754358, 999.9300048996646, 1001.7645853224486, 1005.703317521333, 1016.4307987527009, 16973.0, 17101.552009025334, 17539.0, 17717.46847594574, 17789.0, 28815.694744420816, 38161.427578586896, 41800.3729944045, 42825.571744282155, 43112.0, 55729.0, 56377.436225638856, 56666.433335666115, 57419.712901435225, 57802.13296800636, 7631.427642926914, 7711.305982461606, 7743.419243556643, 7772.805679858049, 7850.0, 9448.48033358172, 13023.739525209254, 13155.934220328838, 13238.933805330911, 13331.866681333062, 11248.94375528117, 11409.486573104065, 11657.125715571197, 11678.24091434054, 11846.11154163424, 11225.214235003472, 11239.831402528805, 11598.362090085126, 11618.477168527268, 11689.298642081503, 11611.825822612498, 11667.124965627781, 11781.175317727677, 11911.047116230855, 11990.460429280529, 7358.96320518394, 7531.435142364235, 7584.962075189809, 7787.4548781584745, 8530.317574594143, 10426.165906727596, 11373.829392559284, 11447.141464390037, 11619.244749091282, 11628.883711163118], "value": 8689.89520711158, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1280.7694614969314, 1423.5693128405953, 1450.6808502129531, 1564.827868934417, 1720.819313972033, 7052.541584796991, 7642.312191902728, 7897.407694422913, 7915.287624113836, 8073.91926080739, 7911.36709063275, 7947.284744373005, 7987.680492780281, 7992.240737129978, 7997.280244777969, 2103.547737236494, 2132.2110818996994, 2140.721706178195, 2141.4004078857943, 2141.550274442361, 2058.475088852348, 2107.8524503284775, 2118.4597927528457, 2128.797764212405, 2144.378130342199, 2078.646630072891, 2116.904739286736, 2133.4666333416644, 2133.765285818559, 2160.935171944844, 2098.412444515538, 2099.3939636178334, 2102.432343267317, 2105.7894210578975, 2109.1457959526265, 2038.8674736142252, 2090.780468050848, 2096.790320967906, 2098.097817938286, 2115.968260476094, 7825.843483130362, 7833.921660783376, 7838.490498117604, 7890.1715319891155, 8097.635606397726, 4694.2958556216845, 4826.95173048272, 4853.95146048542, 4857.247126695333, 4858.659893807435, 2982.7613790896676, 3153.7634677399287, 3167.9683203167906, 3188.872445102193, 3223.919402014945, 1060.9363438193734, 1067.1836045425257, 1068.150820098016, 1084.0839490630406, 1102.2725001499052, 10613.5223914924, 10617.097546708539, 10689.572417103229, 10701.732456688567, 10733.248672592921, 3831.348670725983, 3859.1895701902913, 3988.3818008208773, 4035.7376770509823, 4043.7169398142437, 8486.32109431244, 8539.06070332263, 8553.272971797467, 8565.61454734526, 8584.0, 4679.134360143385, 4682.508336624674, 4686.109639168547, 4692.6245900327895, 4693.718376897329, 3805.3911374179997, 3880.4567360569545, 3913.2369188008065, 4438.5561443856, 4440.822367105279, 3167.2081979505124, 3491.231928975672, 3567.518385018041, 3588.300281445145, 3595.460680897886, 1021.1473419694638, 1040.105509262034, 1051.3166441812882, 1058.1640504001753, 1080.783843231357, 929.4469790474657, 939.9765005874908, 943.3490891284991, 952.4190243951184, 970.3498655900563, 5463.071277882769, 5481.571696681701, 5491.588130890199, 5539.639923404966, 5842.707864606753, 399.38694104549955, 403.00457869063365, 412.23736088236524, 421.2060266397862, 421.80807732481645, 3911.8630847920185, 3964.841406343714, 3977.5823538528616, 3998.4605926718423, 4011.4584531088512, 9274.536273186313, 9590.712278631652, 9601.47191904452, 9717.951410243046, 9723.854142187873, 9602.135807777195, 9652.131308182157, 9662.806743865083, 9695.127438530566, 9718.75703107428, 7371.336579707745, 7441.404687624977, 7443.2184620615135, 7477.439192060618, 7502.3622992046285, 5326.840194794162, 5419.810306639249, 5562.082256427644, 5625.46558076982, 5705.885882282414, 8639.352048596254, 8723.563821808757, 8733.344999124964, 8813.074627164055, 8843.098733772269, 9033.548322583712, 9036.864447033167, 9100.453972761656, 9118.22495087925, 9118.635254589743, 6163.3836616338, 6371.076193951758, 6485.6108633482145, 6702.061711360316, 6722.663866806738, 7710.807229819299, 7755.030621172354, 7755.92244077552, 7778.766637000899, 7781.182975787688, 6795.354441328066, 6819.079424277659, 6840.144981877265, 6929.584224946318, 7039.507234493741, 6781.660916954232, 6830.487713421613, 6836.589804611739, 6857.382835544825, 6864.519483636098, 6340.365963403623, 6345.650989195638, 6384.585001974857, 6385.553011289351, 6420.101185834081, 4692.0, 4781.713097214179, 4839.080574690797, 4862.100511405401, 4948.0, 4945.332380128781, 4952.133376659142, 4977.552020318189, 4990.850274491771, 5038.294638750504], "value": 4104.046695955956, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [288.55274324796574, 293.8193011298051, 302.5582649331975, 304.69073890001664, 306.2619087997924, 5110.565601923841, 5226.451222621627, 5250.343707036621, 5278.89442211156, 5323.1749078892835, 5076.416212135606, 5173.534381905628, 5187.922181167285, 5252.894942101165, 5286.2070689396605, 4078.3270760324513, 4081.9387709184384, 4105.240530501852, 4112.712110152291, 4122.670186385097, 3798.3163030654473, 3977.224441233946, 4063.1264278180183, 4109.773962432065, 4131.380292956065, 3960.4851369321946, 3970.1265721541213, 3992.441058251847, 3992.983543310624, 4010.7794071326066, 3984.485895359759, 3985.0871581640686, 4000.3399439092514, 4008.3386241270155, 4031.3751368537633, 3504.8072356020407, 3505.5092287079574, 3522.894313170609, 3523.0, 3525.1010992196825, 4927.827526036572, 5127.154019586764, 5137.897242055175, 5153.252778347156, 5163.586913046947, 4565.56627120423, 4583.518730533279, 4594.540545945412, 4601.516840731709, 4601.815927362902, 5436.238926550286, 5449.155380915964, 5457.645253058538, 5459.890802183934, 5470.91793623096, 3701.574893665931, 3793.9620603793883, 3797.025546715692, 3829.9042523936846, 3845.8653947111998, 5664.2636457260705, 5687.914681279784, 5692.487676109128, 5697.544196464273, 5698.202251684767, 3911.374180131222, 3916.2559113768293, 3917.059905622687, 3919.7060220483577, 3945.612904192922, 3870.1872606752336, 3956.2680904032845, 3962.881113566598, 3978.8806335809973, 3992.2215168041953, 4563.977180114078, 4580.839670611513, 4584.587387135174, 4600.263957766741, 4609.446866376056, 5469.453054694578, 5469.589780766459, 5469.863253418617, 5482.122860342326, 5490.6431081979545, 1288.904431233463, 1325.7945018522144, 1337.2310921220337, 1354.525915929417, 1364.1883079567642, 893.3300024981264, 908.4685459006423, 921.318224513855, 927.9628814847465, 930.1767935377239, 5251.553617942518, 5258.947410525922, 5272.393674727378, 5273.868153296198, 5277.129273669878, 5578.442155784389, 5585.162225666182, 5599.328080630269, 5604.299462567179, 5604.859878502988, 4980.452150263468, 5152.3044389007, 5220.251215842659, 5275.287836142148, 5279.208118782213, 2569.7301783312855, 2571.9357016074746, 2595.260350800013, 2597.5713357653217, 2601.0, 4994.600431965434, 4995.0, 4998.225275082368, 5022.397312322545, 5024.773885175176, 4605.69452999264, 4939.468280179617, 4947.936193718368, 5013.523715247045, 5023.321851550067, 4982.302477653059, 5061.443241243386, 5081.0, 5084.77118529667, 5086.694798312114, 4830.541098595628, 4837.975810120927, 4847.2729090636685, 4850.442199147144, 4900.803967841246, 4830.830920917751, 4845.5881250094135, 5173.430922598586, 5566.190987928859, 5614.6631202128, 5858.648481091148, 5867.471927526543, 5870.5010074142465, 5873.530117590497, 5909.911351329648, 3878.2825177342283, 3880.631340022693, 3890.3191941409573, 3897.4738410314244, 3917.942155618024, 5362.276092727588, 5413.7834486620095, 5620.178278770475, 5682.914756278742, 5734.885302294014, 5474.315710536183, 5475.315585551806, 5632.127020311858, 5670.716464176857, 5683.959081891168, 5594.804181853616, 5614.782161046282, 5620.0, 5644.6330988485615, 5653.971730141488, 5279.815206467755, 5518.889622207614, 5526.889462210814, 5578.246936663499, 5607.971960140173, 5565.387807341108, 5572.773989722255, 5606.355269143937, 5607.831765047055, 5633.521150702236, 5516.420775818642, 5519.503244707996, 5524.900537795612, 5536.501714845684, 5537.224788529528], "value": 4063.929756371169, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [669.4176066821863, 722.3895808042204, 739.7336958694866, 745.2026331824947, 862.9084208476279, 14946.25268736563, 16536.75194872078, 16687.415940442086, 16790.328386864512, 16809.075500847448, 15233.238338083107, 15515.767263491029, 15532.45636402726, 15541.378344866192, 15545.844541554581, 670.9630970296631, 808.8948436703221, 831.4138532334689, 834.7704381295162, 835.3859912963967, 690.6615758278433, 809.9676012959475, 817.8854960305562, 826.7519744076753, 833.1127349372929, 862.762740246431, 863.8401895649293, 864.9221570058694, 865.1262225152578, 865.126222515261, 694.6769752065314, 857.9442336248186, 860.152749541704, 860.6127242740761, 861.6294993152942, 521.5957632834545, 603.3544107804651, 609.9908501372483, 615.6244690738646, 618.1407843098098, 14523.419063237458, 14541.418343266256, 14568.562943111723, 14571.125732456087, 14575.125492470379, 13817.723645527034, 14175.929120354436, 14565.854341456661, 14695.632609184855, 15011.699766004727, 13040.217586944813, 13180.53868114621, 13208.141470804367, 13425.66435839102, 13477.19136851792, 4347.934780978288, 4361.454818147731, 4460.821567137311, 4461.687681862271, 4491.438570178728, 76108.2561836395, 76110.6194469024, 76491.61754191249, 76508.61745691292, 76635.61682191554, 10837.620683276047, 11066.114710823114, 11144.05275551571, 11222.382768947624, 11518.654440366803, 19401.611967760848, 20161.899190503955, 20171.495712607008, 20789.1684332625, 20808.167673293203, 8431.77169234732, 8742.388032837767, 8755.0807165248, 8803.987541432689, 8817.16236957488, 4664.416947881515, 4675.509071547439, 4754.595859351994, 4761.262004389325, 4835.95164048355, 3561.0919215600375, 3672.540932383452, 3676.852925882935, 3685.74199806011, 3688.5389326334207, 642.6497558830355, 677.6984242012257, 684.551618689759, 687.3779229797042, 697.6965020216222, 713.5468977199515, 728.9562626242337, 729.3727394440776, 737.376916505552, 779.185750890321, 9299.395539289924, 9925.156361709336, 10348.637797677045, 10434.269601127848, 10502.894971050191, 661.3882159002903, 714.0, 746.7125156814666, 759.4380158682535, 775.2712450296704, 4463.799129039201, 4600.838970636011, 4643.0, 4678.532146785295, 4769.642276829182, 75415.62292188503, 104145.0, 117899.0, 119747.0, 120261.39869300598, 99102.0, 100158.0, 103417.0, 104471.4776426113, 106496.9350306487, 69855.99999999898, 89510.55244723735, 91009.54495227613, 91897.0, 92168.53915730378, 9156.22172115351, 9790.363626364264, 10446.134930075921, 10448.843267350843, 10701.678949631523, 45663.77518388168, 46971.0, 47166.52833471621, 48370.274445882635, 49065.50934490752, 65338.0, 70279.64860175666, 70948.64525677338, 71607.64196179195, 71969.0, 12820.0, 12827.871721282667, 12848.0, 12858.164219325714, 13232.735345293233, 14230.715385692021, 14683.48607798722, 14704.0, 14793.186374749492, 15442.536723898302, 13548.32258387057, 13770.93114534461, 14181.361838717075, 14921.104733716013, 15081.321340539922, 13219.537316193888, 13343.266120363473, 13457.259850708306, 13773.793393099311, 14237.50168744089, 13163.276019819003, 13906.860931390556, 14470.059446135967, 14486.637834054232, 14606.0, 11173.162012848907, 11410.315381077162, 11568.24806387582, 11825.526978920747, 12184.939075304566, 10511.737206569896, 11662.88337116618, 11697.387831736321, 11719.163644718725, 11925.403729813648], "value": 7647.324672937843, "unit": "score"}], "name": "dromaeo_css", "value": 6844.665368826541, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 113.0, 113.0, 111.0, 116.0, 113.0, 114.0, 113.0, 114.0, 112.0], "value": 112.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 122.0, 123.0, 159.0, 125.0, 127.0, 128.0, 125.0, 182.0, 126.0], "value": 136.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 162.0, 164.0, 163.0, 164.0, 165.0, 164.0, 164.0, 162.0, 163.0], "value": 163.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 77.0, 104.0, 77.0, 78.0, 78.0, 76.0, 107.0, 79.0], "value": 82.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 83.0, 119.0, 83.0, 84.0, 82.0, 103.0, 82.0, 84.0, 119.0], "value": 92.4, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 116.0, 116.0, 117.0, 117.0, 116.0, 116.0, 117.0, 119.0, 118.0], "value": 116.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 148.0, 148.0, 147.0, 149.0, 148.0, 147.0, 147.0, 148.0, 147.0], "value": 147.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 85.0, 85.0, 85.0, 85.0, 85.0, 86.0, 86.0, 84.0], "value": 85.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 54.0, 53.0, 53.0, 55.0, 54.0, 56.0, 55.0, 55.0, 55.0], "value": 54.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 61.0, 59.0, 60.0, 60.0, 60.0, 59.0, 60.0, 60.0, 59.0], "value": 59.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 82.0, 81.0, 89.0, 80.0, 81.0, 81.0, 81.0, 81.0, 80.0], "value": 81.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [135.0, 166.0, 135.0, 137.0, 138.0, 132.0, 131.0, 135.0, 171.0, 131.0], "value": 141.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [178.0, 179.0, 170.0, 173.0, 179.0, 169.0, 173.0, 178.0, 170.0, 174.0], "value": 174.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 68.0, 68.0, 68.0, 68.0, 68.0, 67.0, 68.0, 69.0, 69.0], "value": 68.3, "unit": "score"}], "name": "kraken", "value": 1516.7999999999997, "alertThreshold": 2.0}]} 19:35:02 INFO - Return code: 0 19:35:02 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 19:35:02 INFO - # TBPL SUCCESS # 19:35:02 INFO - Running post-action listener: _resource_record_post_action 19:35:02 INFO - [mozharness: 2016-10-18 02:35:02.831425Z] Finished run-tests step (success) 19:35:02 INFO - Running post-run listener: _resource_record_post_run 19:35:02 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 0; Write bytes: 394248192; Read time: 0; Write time: 302600 19:35:02 INFO - TinderboxPrint: CPU usage
13.1% 19:35:02 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 19:35:02 INFO - TinderboxPrint: I/O write bytes / time
394,248,192 / 302,600 19:35:02 INFO - TinderboxPrint: CPU idle
8,291.1 (86.9%) 19:35:02 INFO - TinderboxPrint: CPU user
1,201.2 (12.6%) 19:35:02 INFO - TinderboxPrint: Swap in / out
0 / 0 19:35:02 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 105537536; Read time: 0; Write time: 99560 19:35:02 INFO - run-tests - Wall time: 1180s; CPU: 13.0%; Read bytes: 0; Write bytes: 288096256; Read time: 0; Write time: 203036 19:35:03 INFO - Running post-run listener: _upload_blobber_files 19:35:03 INFO - Blob upload gear active. 19:35:03 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 19:35:03 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 19:35:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Inbound', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 19:35:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Inbound -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 19:35:03 INFO - (blobuploader) - INFO - Open directory for files ... 19:35:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 19:35:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:35:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:35:07 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 19:35:07 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:35:07 INFO - (blobuploader) - INFO - Done attempting. 19:35:07 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 19:35:07 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:35:07 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:35:08 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 19:35:08 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:35:08 INFO - (blobuploader) - INFO - Done attempting. 19:35:08 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 19:35:08 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:35:08 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:35:08 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 19:35:08 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:35:08 INFO - (blobuploader) - INFO - Done attempting. 19:35:08 INFO - (blobuploader) - INFO - Iteration through files over. 19:35:08 INFO - Return code: 0 19:35:08 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 19:35:08 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 19:35:08 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/db49ef0e5f73e99a1d4a1a629026c88e117d45025cb00f20ca6e273c25dd52a218690b752f39671a9d6e39b45305122d9a4ea296b6850ecda1b068ea03a8ecb8", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/52389d3799e7735bea90cd06f7c864205aad246c749b1cd8a92ea9202276872dc816aed81d315a10c98703da8e6f5dc82761d072cb9cdbb0a7e142fd53d1b952", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/fdfbaa2223edd4fdf58b6382cb336fa1da4ab235a85e86e2cf60da2f14f89803aff4337487bfe832ff3c057857682e41d61f481232de6d6b3e306cc51321bd64"} 19:35:08 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 19:35:08 INFO - Writing to file /builds/slave/test/properties/blobber_files 19:35:08 INFO - Contents: 19:35:08 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/db49ef0e5f73e99a1d4a1a629026c88e117d45025cb00f20ca6e273c25dd52a218690b752f39671a9d6e39b45305122d9a4ea296b6850ecda1b068ea03a8ecb8", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/52389d3799e7735bea90cd06f7c864205aad246c749b1cd8a92ea9202276872dc816aed81d315a10c98703da8e6f5dc82761d072cb9cdbb0a7e142fd53d1b952", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/fdfbaa2223edd4fdf58b6382cb336fa1da4ab235a85e86e2cf60da2f14f89803aff4337487bfe832ff3c057857682e41d61f481232de6d6b3e306cc51321bd64"} 19:35:08 INFO - Running post-run listener: copy_logs_to_upload_dir 19:35:08 INFO - Copying logs to upload dir... 19:35:08 INFO - mkdir: /builds/slave/test/build/upload/logs 19:35:08 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1236.201103 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-10-17 19:35:08.394107) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-17 19:35:08.398145) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/db49ef0e5f73e99a1d4a1a629026c88e117d45025cb00f20ca6e273c25dd52a218690b752f39671a9d6e39b45305122d9a4ea296b6850ecda1b068ea03a8ecb8", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/52389d3799e7735bea90cd06f7c864205aad246c749b1cd8a92ea9202276872dc816aed81d315a10c98703da8e6f5dc82761d072cb9cdbb0a7e142fd53d1b952", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/fdfbaa2223edd4fdf58b6382cb336fa1da4ab235a85e86e2cf60da2f14f89803aff4337487bfe832ff3c057857682e41d61f481232de6d6b3e306cc51321bd64"} build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011310 build_url: 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476743402/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/db49ef0e5f73e99a1d4a1a629026c88e117d45025cb00f20ca6e273c25dd52a218690b752f39671a9d6e39b45305122d9a4ea296b6850ecda1b068ea03a8ecb8", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/52389d3799e7735bea90cd06f7c864205aad246c749b1cd8a92ea9202276872dc816aed81d315a10c98703da8e6f5dc82761d072cb9cdbb0a7e142fd53d1b952", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/fdfbaa2223edd4fdf58b6382cb336fa1da4ab235a85e86e2cf60da2f14f89803aff4337487bfe832ff3c057857682e41d61f481232de6d6b3e306cc51321bd64"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-17 19:35:08.423994) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-17 19:35:08.424310) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a4ce256d2ec601f24a60a71e000001bc-1476756870.447917-447359131 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004412 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-17 19:35:08.506960) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-17 19:35:08.507298) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-17 19:35:08.507683) ========= ========= Total master_lag: 0.16 =========