builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-043 starttime: 1468610854.54 results: success (0) buildid: 20160715101139 builduid: 085db5ae27964394bf0c6d852b7c9826 revision: 4e3c16ea8fced03ab4ef572f16d4aa4464981e2c ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-15 12:27:34.536706) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-15 12:27:34.537189) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-15 12:27:34.537480) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-15 12:27:34.552908) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:27:34.553232) ========= 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=d2a8c569965ab8367867b893000001a1-1468610853.781037-210783091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-15 12:27:34-- 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: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 104M=0s 2016-07-15 12:27:35 (104 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.089055 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:27:34.656347) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:27:34.656723) ========= 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=d2a8c569965ab8367867b893000001a1-1468610853.781037-210783091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018244 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:27:34.706080) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-07-15 12:27:34.706430) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 4e3c16ea8fced03ab4ef572f16d4aa4464981e2c --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 4e3c16ea8fced03ab4ef572f16d4aa4464981e2c --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=d2a8c569965ab8367867b893000001a1-1468610853.781037-210783091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-15 12:27:35,113 truncating revision to first 12 chars 2016-07-15 12:27:35,113 Setting DEBUG logging. 2016-07-15 12:27:35,114 attempt 1/10 2016-07-15 12:27:35,114 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/4e3c16ea8fce?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-15 12:27:36,578 unpacking tar archive at: mozilla-inbound-4e3c16ea8fce/testing/mozharness/ program finished with exit code 0 elapsedTime=1.946589 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-07-15 12:27:36.666298) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-15 12:27:36.666613) ========= script_repo_revision: 4e3c16ea8fced03ab4ef572f16d4aa4464981e2c ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-15 12:27:36.667005) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-15 12:27:36.667309) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-15 12:27:36.676688) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 32 secs) (at 2016-07-15 12:27:36.677139) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --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-e10s', '--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=d2a8c569965ab8367867b893000001a1-1468610853.781037-210783091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 12:27:37 INFO - MultiFileLogger online at 20160715 12:27:37 in /builds/slave/test 12:27:37 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 12:27:37 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 12:27:37 INFO - {'append_to_log': False, 12:27:37 INFO - 'base_work_dir': '/builds/slave/test', 12:27:37 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 12:27:37 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 12:27:37 INFO - 'branch': 'Mozilla-Inbound', 12:27:37 INFO - 'buildbot_json_path': 'buildprops.json', 12:27:37 INFO - 'config_files': ('talos/linux_config.py',), 12:27:37 INFO - 'default_actions': ('clobber', 12:27:37 INFO - 'read-buildbot-config', 12:27:37 INFO - 'download-and-extract', 12:27:37 INFO - 'populate-webroot', 12:27:37 INFO - 'create-virtualenv', 12:27:37 INFO - 'install', 12:27:37 INFO - 'run-tests'), 12:27:37 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:27:37 INFO - 'download_minidump_stackwalk': True, 12:27:37 INFO - 'download_symbols': 'ondemand', 12:27:37 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 12:27:37 INFO - 'tooltool.py': '/tools/tooltool.py', 12:27:37 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 12:27:37 INFO - '/tools/misc-python/virtualenv.py')}, 12:27:37 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:27:37 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:27:37 INFO - 'installer_path': 'installer.exe', 12:27:37 INFO - 'log_level': 'info', 12:27:37 INFO - 'log_name': 'talos', 12:27:37 INFO - 'log_to_console': True, 12:27:37 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 12:27:37 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 12:27:37 INFO - 'opt_config_files': (), 12:27:37 INFO - 'pip_index': False, 12:27:37 INFO - 'sps_profile': False, 12:27:37 INFO - 'sps_profile_interval': 0, 12:27:37 INFO - 'suite': 'dromaeojs-e10s', 12:27:37 INFO - 'system_bits': '32', 12:27:37 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:27:37 INFO - 'title': 'talos-linux64-ix-043', 12:27:37 INFO - 'tooltool_cache': '/builds/tooltool_cache', 12:27:37 INFO - 'use_talos_json': True, 12:27:37 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 12:27:37 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:27:37 INFO - 'work_dir': 'build'} 12:27:37 INFO - ##### 12:27:37 INFO - ##### Running clobber step. 12:27:37 INFO - ##### 12:27:37 INFO - Running pre-action listener: _resource_record_pre_action 12:27:37 INFO - Running main action method: clobber 12:27:37 INFO - rmtree: /builds/slave/test/build 12:27:37 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 12:27:38 INFO - Running post-action listener: _resource_record_post_action 12:27:38 INFO - ##### 12:27:38 INFO - ##### Finished clobber step (success) 12:27:38 INFO - ##### 12:27:38 INFO - ##### 12:27:38 INFO - ##### Running read-buildbot-config step. 12:27:38 INFO - ##### 12:27:38 INFO - Running pre-action listener: _resource_record_pre_action 12:27:38 INFO - Running main action method: read_buildbot_config 12:27:38 INFO - Using buildbot properties: 12:27:38 INFO - { 12:27:38 INFO - "project": "", 12:27:38 INFO - "product": "firefox", 12:27:38 INFO - "script_repo_revision": "production", 12:27:38 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s", 12:27:38 INFO - "repository": "", 12:27:38 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs-e10s", 12:27:38 INFO - "buildid": "20160715101139", 12:27:38 INFO - "pgo_build": "True", 12:27:38 INFO - "basedir": "/builds/slave/test", 12:27:38 INFO - "buildnumber": 833, 12:27:38 INFO - "slavename": "talos-linux64-ix-043", 12:27:38 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 12:27:38 INFO - "platform": "ubuntu64_hw", 12:27:38 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos", 12:27:38 INFO - "branch": "mozilla-inbound", 12:27:38 INFO - "repo_path": "integration/mozilla-inbound", 12:27:38 INFO - "revision": "4e3c16ea8fced03ab4ef572f16d4aa4464981e2c", 12:27:38 INFO - "stage_platform": "linux64-pgo", 12:27:38 INFO - "builduid": "085db5ae27964394bf0c6d852b7c9826", 12:27:38 INFO - "slavebuilddir": "test" 12:27:38 INFO - } 12:27:38 INFO - Found installer url https://queue.taskcluster.net/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 12:27:38 INFO - Running post-action listener: _resource_record_post_action 12:27:38 INFO - ##### 12:27:38 INFO - ##### Finished read-buildbot-config step (success) 12:27:38 INFO - ##### 12:27:38 INFO - ##### 12:27:38 INFO - ##### Running download-and-extract step. 12:27:38 INFO - ##### 12:27:38 INFO - Running pre-action listener: _resource_record_pre_action 12:27:38 INFO - Running main action method: download_and_extract 12:27:38 INFO - mkdir: /builds/slave/test/build/tests 12:27:38 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:38 INFO - https://queue.taskcluster.net/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 12:27:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 12:27:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 12:27:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 12:27:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 12:27:38 INFO - Downloaded 1361 bytes. 12:27:38 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 12:27:38 INFO - Using the following test package requirements: 12:27:38 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 12:27:38 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:27:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 12:27:38 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:27:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 12:27:38 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:27:38 INFO - u'jsshell-linux-x86_64.zip'], 12:27:38 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:27:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 12:27:38 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 12:27:38 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:27:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 12:27:38 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:27:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 12:27:38 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:27:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 12:27:38 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:27:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 12:27:38 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 12:27:38 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:38 INFO - https://queue.taskcluster.net/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 12:27:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 12:27:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 12:27:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 12:27:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:27:40 INFO - Downloaded 24303887 bytes. 12:27:40 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 12:27:40 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 12:27:41 INFO - Return code: 0 12:27:41 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 12:27:41 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:41 INFO - https://queue.taskcluster.net/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 12:27:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 12:27:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 12:27:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 12:27:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:27:42 INFO - Downloaded 24303887 bytes. 12:27:42 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 12:27:42 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 12:27:43 INFO - Return code: 0 12:27:43 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:43 INFO - https://queue.taskcluster.net/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 12:27:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 12:27:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 12:27:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 12:27:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 12:27:44 INFO - Downloaded 14403333 bytes. 12:27:44 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 12:27:44 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 12:27:45 INFO - Return code: 0 12:27:45 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:45 INFO - https://queue.taskcluster.net/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 12:27:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 12:27:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 12:27:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 12:27:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 12:27:46 INFO - Downloaded 60465087 bytes. 12:27:46 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 12:27:46 INFO - mkdir: /builds/slave/test/properties 12:27:46 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 12:27:46 INFO - Writing to file /builds/slave/test/properties/build_url 12:27:46 INFO - Contents: 12:27:46 INFO - build_url:https://queue.taskcluster.net/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 12:27:47 INFO - Running post-action listener: _resource_record_post_action 12:27:47 INFO - Running post-action listener: set_extra_try_arguments 12:27:47 INFO - ##### 12:27:47 INFO - ##### Finished download-and-extract step (success) 12:27:47 INFO - ##### 12:27:47 INFO - ##### 12:27:47 INFO - ##### Running populate-webroot step. 12:27:47 INFO - ##### 12:27:47 INFO - Running pre-action listener: _resource_record_pre_action 12:27:47 INFO - Running main action method: populate_webroot 12:27:47 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 12:27:47 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 12:27:47 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 12:27:47 INFO - '--tppagecycles', 12:27:47 INFO - '7'], 12:27:47 INFO - 'tests': ['tsvgm']}}, 12:27:47 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 12:27:47 INFO - 'tests': ['tresize', 'tcanvasmark']}, 12:27:47 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 12:27:47 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 12:27:47 INFO - 'tests': ['dromaeo_css', 'kraken']}, 12:27:47 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 12:27:47 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:27:47 INFO - 'talos_options': ['--disable-e10s'], 12:27:47 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:27:47 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:27:47 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:27:47 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:27:47 INFO - 'talos_options': ['--disable-e10s'], 12:27:47 INFO - 'tests': ['damp', 'tps']}, 12:27:47 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:27:47 INFO - 'tests': ['damp', 'tps']}, 12:27:47 INFO - 'g3': {'talos_options': ['--disable-e10s'], 12:27:47 INFO - 'tests': ['dromaeo_dom']}, 12:27:47 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 12:27:47 INFO - 'g4': {'talos_options': ['--disable-e10s'], 12:27:47 INFO - 'tests': ['basic_compositor_video']}, 12:27:47 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 12:27:47 INFO - 'other': {'talos_options': ['--disable-e10s'], 12:27:47 INFO - 'tests': ['a11yr', 12:27:47 INFO - 'ts_paint', 12:27:47 INFO - 'tpaint', 12:27:47 INFO - 'sessionrestore', 12:27:47 INFO - 'sessionrestore_no_auto_restore', 12:27:47 INFO - 'tabpaint']}, 12:27:47 INFO - 'other-e10s': {'tests': ['a11yr', 12:27:47 INFO - 'ts_paint', 12:27:47 INFO - 'tpaint', 12:27:47 INFO - 'sessionrestore', 12:27:47 INFO - 'sessionrestore_no_auto_restore', 12:27:47 INFO - 'tabpaint']}, 12:27:47 INFO - 'other-e10s_l64': {'tests': ['a11yr', 12:27:47 INFO - 'ts_paint', 12:27:47 INFO - 'tpaint', 12:27:47 INFO - 'sessionrestore', 12:27:47 INFO - 'sessionrestore_no_auto_restore', 12:27:47 INFO - 'tabpaint']}, 12:27:47 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 12:27:47 INFO - 'ts_paint', 12:27:47 INFO - 'tpaint', 12:27:47 INFO - 'sessionrestore', 12:27:47 INFO - 'sessionrestore_no_auto_restore', 12:27:47 INFO - 'tabpaint']}, 12:27:47 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 12:27:47 INFO - 'tests': ['a11yr', 12:27:47 INFO - 'ts_paint', 12:27:47 INFO - 'tpaint', 12:27:47 INFO - 'sessionrestore', 12:27:47 INFO - 'sessionrestore_no_auto_restore', 12:27:47 INFO - 'tabpaint']}, 12:27:47 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 12:27:47 INFO - 'tests': ['a11yr', 12:27:47 INFO - 'ts_paint', 12:27:47 INFO - 'tpaint', 12:27:47 INFO - 'sessionrestore', 12:27:47 INFO - 'sessionrestore_no_auto_restore', 12:27:47 INFO - 'tabpaint']}, 12:27:47 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 12:27:47 INFO - 'tests': ['tsvgx', 12:27:47 INFO - 'tsvgr_opacity', 12:27:47 INFO - 'tart', 12:27:47 INFO - 'tscrollx', 12:27:47 INFO - 'cart']}, 12:27:47 INFO - 'svgr-e10s': {'tests': ['tsvgx', 12:27:47 INFO - 'tsvgr_opacity', 12:27:47 INFO - 'tart', 12:27:47 INFO - 'tscrollx', 12:27:47 INFO - 'cart']}, 12:27:47 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:27:47 INFO - 'talos_options': ['--disable-e10s'], 12:27:47 INFO - 'tests': ['tp5o']}, 12:27:47 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:27:47 INFO - 'tests': ['tp5o']}, 12:27:47 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:27:47 INFO - 'talos_options': ['--disable-e10s', 12:27:47 INFO - '--xperf_path', 12:27:47 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:27:47 INFO - 'tests': ['tp5n']}, 12:27:47 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:27:47 INFO - 'talos_options': ['--xperf_path', 12:27:47 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:27:47 INFO - 'tests': ['tp5n']}}, 12:27:47 INFO - 'talos.zip': {'path': '', 12:27:47 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:27:47 INFO - Running post-action listener: _resource_record_post_action 12:27:47 INFO - ##### 12:27:47 INFO - ##### Finished populate-webroot step (success) 12:27:47 INFO - ##### 12:27:47 INFO - ##### 12:27:47 INFO - ##### Running create-virtualenv step. 12:27:47 INFO - ##### 12:27:47 INFO - Running pre-action listener: _resource_record_pre_action 12:27:47 INFO - Running main action method: create_virtualenv 12:27:47 INFO - Creating virtualenv /builds/slave/test/build/venv 12:27:47 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 12:27:47 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 12:27:47 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 12:27:47 INFO - Using real prefix '/usr' 12:27:47 INFO - New python executable in /builds/slave/test/build/venv/bin/python 12:27:47 INFO - Installing distribute.............................................................................................................................................................................................done. 12:27:49 INFO - Installing pip.................done. 12:27:49 INFO - Return code: 0 12:27:49 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 12:27: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:27:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:27: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:27:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:27: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24b3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e2400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2771570>, '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 0x2772470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2772900>, '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': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', '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 12:27: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', 'pip>=1.5'] in /builds/slave/test/build 12:27: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 pip>=1.5 12:27:49 INFO - Using env: {'DISPLAY': ':0', 12:27:49 INFO - 'HOME': '/home/cltbld', 12:27:49 INFO - 'LANG': 'en_US.UTF-8', 12:27:49 INFO - 'LANGUAGE': 'en_US:en', 12:27:49 INFO - 'LOGNAME': 'cltbld', 12:27:49 INFO - 'MAIL': '/var/mail/cltbld', 12:27:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:27:49 INFO - 'MOZ_NO_REMOTE': '1', 12:27:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:27:49 INFO - 'NO_EM_RESTART': '1', 12:27:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:27:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:27:49 INFO - 'PWD': '/builds/slave/test', 12:27:49 INFO - 'SHELL': '/bin/bash', 12:27:49 INFO - 'SHLVL': '1', 12:27:49 INFO - 'TERM': 'linux', 12:27:49 INFO - 'TMOUT': '86400', 12:27:49 INFO - 'USER': 'cltbld', 12:27:49 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', 12:27:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:27:49 INFO - '_': '/tools/buildbot/bin/python'} 12:27:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:27:50 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 12:27:50 INFO - Cleaning up... 12:27:50 INFO - Return code: 0 12:27:50 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 12:27:50 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:27:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:27:50 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:27:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:27:50 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 0x24b3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e2400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2771570>, '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 0x2772470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2772900>, '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': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', '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 12:27:50 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 12:27:50 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 12:27:50 INFO - Using env: {'DISPLAY': ':0', 12:27:50 INFO - 'HOME': '/home/cltbld', 12:27:50 INFO - 'LANG': 'en_US.UTF-8', 12:27:50 INFO - 'LANGUAGE': 'en_US:en', 12:27:50 INFO - 'LOGNAME': 'cltbld', 12:27:50 INFO - 'MAIL': '/var/mail/cltbld', 12:27:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:27:50 INFO - 'MOZ_NO_REMOTE': '1', 12:27:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:27:50 INFO - 'NO_EM_RESTART': '1', 12:27:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:27:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:27:50 INFO - 'PWD': '/builds/slave/test', 12:27:50 INFO - 'SHELL': '/bin/bash', 12:27:50 INFO - 'SHLVL': '1', 12:27:50 INFO - 'TERM': 'linux', 12:27:50 INFO - 'TMOUT': '86400', 12:27:50 INFO - 'USER': 'cltbld', 12:27:50 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', 12:27:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:27:50 INFO - '_': '/tools/buildbot/bin/python'} 12:27:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:27:50 INFO - Downloading/unpacking psutil>=3.1.1 12:27:50 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 12:27:50 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 12:27:50 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 12:27:50 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 12:27:50 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 12:27:50 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 12:27:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 12:27:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:27:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:27:52 INFO - Installing collected packages: psutil 12:27:52 INFO - Running setup.py install for psutil 12:27:52 INFO - building 'psutil._psutil_linux' extension 12:27:52 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 12:27:52 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 12:27:52 INFO - building 'psutil._psutil_posix' extension 12:27:52 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 12:27:52 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 12:27:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:27:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:27:52 INFO - Successfully installed psutil 12:27:52 INFO - Cleaning up... 12:27:52 INFO - Return code: 0 12:27:52 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 12:27:52 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:27:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:27:52 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:27:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:27:52 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 0x24b3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e2400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2771570>, '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 0x2772470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2772900>, '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': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', '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 12:27:52 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 12:27:52 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 12:27:52 INFO - Using env: {'DISPLAY': ':0', 12:27:52 INFO - 'HOME': '/home/cltbld', 12:27:52 INFO - 'LANG': 'en_US.UTF-8', 12:27:52 INFO - 'LANGUAGE': 'en_US:en', 12:27:52 INFO - 'LOGNAME': 'cltbld', 12:27:52 INFO - 'MAIL': '/var/mail/cltbld', 12:27:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:27:52 INFO - 'MOZ_NO_REMOTE': '1', 12:27:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:27:52 INFO - 'NO_EM_RESTART': '1', 12:27:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:27:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:27:52 INFO - 'PWD': '/builds/slave/test', 12:27:52 INFO - 'SHELL': '/bin/bash', 12:27:52 INFO - 'SHLVL': '1', 12:27:52 INFO - 'TERM': 'linux', 12:27:52 INFO - 'TMOUT': '86400', 12:27:52 INFO - 'USER': 'cltbld', 12:27:52 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', 12:27:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:27:52 INFO - '_': '/tools/buildbot/bin/python'} 12:27:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:27:53 INFO - Downloading/unpacking mozsystemmonitor==0.3 12:27: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 12:27: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 12:27: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 12:27: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 12:27: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 12:27: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 12:27:55 INFO - Downloading mozsystemmonitor-0.3.tar.gz 12:27:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 12:27:55 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 12:27:55 INFO - Installing collected packages: mozsystemmonitor 12:27:55 INFO - Running setup.py install for mozsystemmonitor 12:27:55 INFO - Successfully installed mozsystemmonitor 12:27:55 INFO - Cleaning up... 12:27:55 INFO - Return code: 0 12:27:55 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 12:27:55 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:27:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:27:55 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:27:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:27:55 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 0x24b3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e2400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2771570>, '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 0x2772470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2772900>, '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': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', '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 12:27:55 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 12:27:55 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 12:27:55 INFO - Using env: {'DISPLAY': ':0', 12:27:55 INFO - 'HOME': '/home/cltbld', 12:27:55 INFO - 'LANG': 'en_US.UTF-8', 12:27:55 INFO - 'LANGUAGE': 'en_US:en', 12:27:55 INFO - 'LOGNAME': 'cltbld', 12:27:55 INFO - 'MAIL': '/var/mail/cltbld', 12:27:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:27:55 INFO - 'MOZ_NO_REMOTE': '1', 12:27:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:27:55 INFO - 'NO_EM_RESTART': '1', 12:27:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:27:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:27:55 INFO - 'PWD': '/builds/slave/test', 12:27:55 INFO - 'SHELL': '/bin/bash', 12:27:55 INFO - 'SHLVL': '1', 12:27:55 INFO - 'TERM': 'linux', 12:27:55 INFO - 'TMOUT': '86400', 12:27:55 INFO - 'USER': 'cltbld', 12:27:55 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', 12:27:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:27:55 INFO - '_': '/tools/buildbot/bin/python'} 12:27:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:27:55 INFO - Downloading/unpacking jsonschema==2.5.1 12:27:55 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 12:27:55 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 12:27:55 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 12:27:55 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 12:27:55 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 12:27:55 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 12:27:57 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:27:57 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 12:27: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 12:27: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 12:27: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 12:27: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 12:27: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 12:27: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 12:27:57 INFO - Downloading functools32-3.2.3-2.tar.gz 12:27:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 12:27:57 INFO - warning: no files found matching '*.txt' 12:27:57 INFO - no previously-included directories found matching 'build' 12:27:57 INFO - no previously-included directories found matching 'dist' 12:27:57 INFO - no previously-included directories found matching '.git*' 12:27:57 INFO - Installing collected packages: jsonschema, functools32 12:27:57 INFO - Running setup.py install for functools32 12:27:57 INFO - warning: no files found matching '*.txt' 12:27:57 INFO - no previously-included directories found matching 'build' 12:27:57 INFO - no previously-included directories found matching 'dist' 12:27:57 INFO - no previously-included directories found matching '.git*' 12:27:57 INFO - Successfully installed jsonschema functools32 12:27:57 INFO - Cleaning up... 12:27:57 INFO - Return code: 0 12:27:57 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 12:27:57 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:27:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:27:57 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:27:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:27:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:27:57 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 0x24b3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e2400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2771570>, '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 0x2772470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2772900>, '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': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', '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 12:27:57 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 12:27:57 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 12:27:57 INFO - Using env: {'DISPLAY': ':0', 12:27:57 INFO - 'HOME': '/home/cltbld', 12:27:57 INFO - 'LANG': 'en_US.UTF-8', 12:27:57 INFO - 'LANGUAGE': 'en_US:en', 12:27:57 INFO - 'LOGNAME': 'cltbld', 12:27:57 INFO - 'MAIL': '/var/mail/cltbld', 12:27:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:27:57 INFO - 'MOZ_NO_REMOTE': '1', 12:27:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:27:57 INFO - 'NO_EM_RESTART': '1', 12:27:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:27:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:27:57 INFO - 'PWD': '/builds/slave/test', 12:27:57 INFO - 'SHELL': '/bin/bash', 12:27:57 INFO - 'SHLVL': '1', 12:27:57 INFO - 'TERM': 'linux', 12:27:57 INFO - 'TMOUT': '86400', 12:27:57 INFO - 'USER': 'cltbld', 12:27:57 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', 12:27:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:27:57 INFO - '_': '/tools/buildbot/bin/python'} 12:27:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:27:58 INFO - Downloading/unpacking blobuploader==1.2.4 12:27:58 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 12:27:58 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 12:27:58 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 12:27:58 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 12:27:58 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 12:27:58 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 12:27:59 INFO - Downloading blobuploader-1.2.4.tar.gz 12:28:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:28:00 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:28:00 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 12:28:00 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 12:28:00 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 12:28:00 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 12:28:00 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 12:28:00 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 12:28:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 12:28:00 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:28:00 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 12:28:00 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 12:28:00 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 12:28:00 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 12:28:00 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 12:28:00 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 12:28:00 INFO - Downloading docopt-0.6.1.tar.gz 12:28:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 12:28:00 INFO - Installing collected packages: blobuploader, requests, docopt 12:28:00 INFO - Running setup.py install for blobuploader 12:28:00 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:28:00 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 12:28:00 INFO - Running setup.py install for requests 12:28:01 INFO - Running setup.py install for docopt 12:28:01 INFO - Successfully installed blobuploader requests docopt 12:28:01 INFO - Cleaning up... 12:28:01 INFO - Return code: 0 12:28:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:28: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:28:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:28:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:01 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 0x24b3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e2400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2771570>, '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 0x2772470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2772900>, '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': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', '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 12:28:01 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 12:28:01 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 12:28:01 INFO - Using env: {'DISPLAY': ':0', 12:28:01 INFO - 'HOME': '/home/cltbld', 12:28:01 INFO - 'LANG': 'en_US.UTF-8', 12:28:01 INFO - 'LANGUAGE': 'en_US:en', 12:28:01 INFO - 'LOGNAME': 'cltbld', 12:28:01 INFO - 'MAIL': '/var/mail/cltbld', 12:28:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:01 INFO - 'MOZ_NO_REMOTE': '1', 12:28:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:01 INFO - 'NO_EM_RESTART': '1', 12:28:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:01 INFO - 'PWD': '/builds/slave/test', 12:28:01 INFO - 'SHELL': '/bin/bash', 12:28:01 INFO - 'SHLVL': '1', 12:28:01 INFO - 'TERM': 'linux', 12:28:01 INFO - 'TMOUT': '86400', 12:28:01 INFO - 'USER': 'cltbld', 12:28:01 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', 12:28:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:01 INFO - '_': '/tools/buildbot/bin/python'} 12:28:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:28:01 INFO - Running setup.py (path:/tmp/pip-JsFMpu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:28:01 INFO - Running setup.py (path:/tmp/pip-JTAd42-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:28:01 INFO - Running setup.py (path:/tmp/pip-4fietC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:28:01 INFO - Running setup.py (path:/tmp/pip-SLSmfg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:28:01 INFO - Running setup.py (path:/tmp/pip-YZC8rg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:28:01 INFO - Running setup.py (path:/tmp/pip-C1Wils-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:28:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:28:02 INFO - Running setup.py (path:/tmp/pip-jP10Vz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:28:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:28:02 INFO - Running setup.py (path:/tmp/pip-OXmauZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:28:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:28:02 INFO - Running setup.py (path:/tmp/pip-ODJMT1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:28:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:28:02 INFO - Running setup.py (path:/tmp/pip-aRc6Md-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:28:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:28:02 INFO - Running setup.py (path:/tmp/pip-Uzl2PW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:28:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:28:02 INFO - Running setup.py (path:/tmp/pip-lcLOiv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:28:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:28:02 INFO - Running setup.py (path:/tmp/pip-380Ic5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:28:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:28:02 INFO - Running setup.py (path:/tmp/pip-RQKRe0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:28:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:28:02 INFO - Running setup.py (path:/tmp/pip-s62tZl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:28:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:28:02 INFO - Running setup.py (path:/tmp/pip-_Gf1sB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:28:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:28:02 INFO - Running setup.py (path:/tmp/pip-J_Czcn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:28:02 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:28:02 INFO - Running setup.py install for manifestparser 12:28:02 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 12:28:02 INFO - Running setup.py install for mozcrash 12:28:03 INFO - Running setup.py install for mozdebug 12:28:03 INFO - Running setup.py install for mozdevice 12:28:03 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 12:28:03 INFO - Installing dm script to /builds/slave/test/build/venv/bin 12:28:03 INFO - Running setup.py install for mozfile 12:28:03 INFO - Running setup.py install for mozhttpd 12:28:03 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 12:28:03 INFO - Running setup.py install for mozinfo 12:28:03 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 12:28:03 INFO - Running setup.py install for mozInstall 12:28:03 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 12:28:03 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 12:28:03 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 12:28:03 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 12:28:03 INFO - Running setup.py install for mozleak 12:28:03 INFO - Running setup.py install for mozlog 12:28:03 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 12:28:03 INFO - Running setup.py install for moznetwork 12:28:03 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 12:28:03 INFO - Running setup.py install for mozprocess 12:28:04 INFO - Running setup.py install for mozprofile 12:28:04 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 12:28:04 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 12:28:04 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 12:28:04 INFO - Running setup.py install for mozrunner 12:28:04 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 12:28:04 INFO - Running setup.py install for mozscreenshot 12:28:04 INFO - Running setup.py install for moztest 12:28:04 INFO - Running setup.py install for mozversion 12:28:04 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 12:28:04 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:28:04 INFO - Cleaning up... 12:28:04 INFO - Return code: 0 12:28:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:28:04 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:28:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:04 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:28:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:04 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 0x24b3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e2400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2771570>, '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 0x2772470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2772900>, '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': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', '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 12:28:04 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 12:28:04 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 12:28:04 INFO - Using env: {'DISPLAY': ':0', 12:28:04 INFO - 'HOME': '/home/cltbld', 12:28:04 INFO - 'LANG': 'en_US.UTF-8', 12:28:04 INFO - 'LANGUAGE': 'en_US:en', 12:28:04 INFO - 'LOGNAME': 'cltbld', 12:28:04 INFO - 'MAIL': '/var/mail/cltbld', 12:28:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:04 INFO - 'MOZ_NO_REMOTE': '1', 12:28:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:04 INFO - 'NO_EM_RESTART': '1', 12:28:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:04 INFO - 'PWD': '/builds/slave/test', 12:28:04 INFO - 'SHELL': '/bin/bash', 12:28:04 INFO - 'SHLVL': '1', 12:28:04 INFO - 'TERM': 'linux', 12:28:04 INFO - 'TMOUT': '86400', 12:28:04 INFO - 'USER': 'cltbld', 12:28:04 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', 12:28:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:04 INFO - '_': '/tools/buildbot/bin/python'} 12:28:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:28:04 INFO - Running setup.py (path:/tmp/pip-qfldV3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:28:04 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)) 12:28:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:28:04 INFO - Running setup.py (path:/tmp/pip-fRC4fH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:28:04 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)) 12:28:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:28:04 INFO - Running setup.py (path:/tmp/pip-RExuRE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:28:05 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)) 12:28:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:28:05 INFO - Running setup.py (path:/tmp/pip-FBxdt_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:28:05 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)) 12:28:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:28:05 INFO - Running setup.py (path:/tmp/pip-V1RM5r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:28:05 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)) 12:28:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:28:05 INFO - Running setup.py (path:/tmp/pip-if_TI6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:28:05 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)) 12:28:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:28:05 INFO - Running setup.py (path:/tmp/pip-smaNR_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:28:05 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)) 12:28:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:28:05 INFO - Running setup.py (path:/tmp/pip-oQ3OoY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:28:05 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)) 12:28:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:28:05 INFO - Running setup.py (path:/tmp/pip-MIp7dc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:28:05 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)) 12:28:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:28:05 INFO - Running setup.py (path:/tmp/pip-EBvKm_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:28:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 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)) 12:28:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:28:05 INFO - Running setup.py (path:/tmp/pip-BsY3uD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:28:05 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)) 12:28:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:28:05 INFO - Running setup.py (path:/tmp/pip-lCK9XI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:28:05 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)) 12:28:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:28:05 INFO - Running setup.py (path:/tmp/pip-L6bNqu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:28:05 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)) 12:28:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:28:05 INFO - Running setup.py (path:/tmp/pip-huEn8k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:28:05 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)) 12:28:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:28:05 INFO - Running setup.py (path:/tmp/pip-0H3n9A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:28:05 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)) 12:28:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:28:05 INFO - Running setup.py (path:/tmp/pip-t0W_k0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:28:06 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)) 12:28:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:28:06 INFO - Running setup.py (path:/tmp/pip-X8YQhB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:28:06 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)) 12:28:06 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)) 12:28:06 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)) 12:28:06 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)) 12:28:06 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)) 12:28:06 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)) 12:28:06 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:28:06 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 12:28:06 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 12:28:06 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 12:28:06 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 12:28:06 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 12:28:06 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 12:28:08 INFO - Downloading blessings-1.6.tar.gz 12:28:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 12:28:08 INFO - Installing collected packages: blessings 12:28:08 INFO - Running setup.py install for blessings 12:28:08 INFO - Successfully installed blessings 12:28:08 INFO - Cleaning up... 12:28:08 INFO - Return code: 0 12:28:08 INFO - Done creating virtualenv /builds/slave/test/build/venv. 12:28:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:28:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:28:08 INFO - Reading from file tmpfile_stdout 12:28:08 INFO - Current package versions: 12:28:08 INFO - argparse == 1.2.1 12:28:08 INFO - blessings == 1.6 12:28:08 INFO - blobuploader == 1.2.4 12:28:08 INFO - docopt == 0.6.1 12:28:08 INFO - functools32 == 3.2.3-2 12:28:08 INFO - jsonschema == 2.5.1 12:28:08 INFO - manifestparser == 1.1 12:28:08 INFO - mozInstall == 1.12 12:28:08 INFO - mozcrash == 0.17 12:28:08 INFO - mozdebug == 0.1 12:28:08 INFO - mozdevice == 0.48 12:28:08 INFO - mozfile == 1.2 12:28:08 INFO - mozhttpd == 0.7 12:28:08 INFO - mozinfo == 0.9 12:28:08 INFO - mozleak == 0.1 12:28:08 INFO - mozlog == 3.2 12:28:08 INFO - moznetwork == 0.27 12:28:08 INFO - mozprocess == 0.23 12:28:08 INFO - mozprofile == 0.28 12:28:08 INFO - mozrunner == 6.12 12:28:08 INFO - mozscreenshot == 0.1 12:28:08 INFO - mozsystemmonitor == 0.3 12:28:08 INFO - moztest == 0.7 12:28:08 INFO - mozversion == 1.4 12:28:08 INFO - psutil == 3.1.1 12:28:08 INFO - requests == 1.2.3 12:28:08 INFO - wsgiref == 0.1.2 12:28:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:28:08 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:28:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:08 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:28:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:08 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 0x24b3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e2400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2771570>, '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 0x2772470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2772900>, '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': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', '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 12:28:08 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 12:28:08 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 12:28:08 INFO - Using env: {'DISPLAY': ':0', 12:28:08 INFO - 'HOME': '/home/cltbld', 12:28:08 INFO - 'LANG': 'en_US.UTF-8', 12:28:08 INFO - 'LANGUAGE': 'en_US:en', 12:28:08 INFO - 'LOGNAME': 'cltbld', 12:28:08 INFO - 'MAIL': '/var/mail/cltbld', 12:28:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:08 INFO - 'MOZ_NO_REMOTE': '1', 12:28:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:08 INFO - 'NO_EM_RESTART': '1', 12:28:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:08 INFO - 'PWD': '/builds/slave/test', 12:28:08 INFO - 'SHELL': '/bin/bash', 12:28:08 INFO - 'SHLVL': '1', 12:28:08 INFO - 'TERM': 'linux', 12:28:08 INFO - 'TMOUT': '86400', 12:28:08 INFO - 'USER': 'cltbld', 12:28:08 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', 12:28:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:08 INFO - '_': '/tools/buildbot/bin/python'} 12:28:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:08 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)) 12:28:08 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)) 12:28:08 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)) 12:28:08 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)) 12:28:08 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)) 12:28:08 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)) 12:28:08 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)) 12:28:08 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)) 12:28:08 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)) 12:28:08 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)) 12:28:08 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)) 12:28:08 INFO - Cleaning up... 12:28:08 INFO - Return code: 0 12:28:08 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 12:28:08 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:28:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:08 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:28:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:08 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 0x24b3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26e2400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2771570>, '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 0x2772470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2772900>, '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': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', '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 12:28:08 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 12:28:08 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 12:28:08 INFO - Using env: {'DISPLAY': ':0', 12:28:08 INFO - 'HOME': '/home/cltbld', 12:28:08 INFO - 'LANG': 'en_US.UTF-8', 12:28:08 INFO - 'LANGUAGE': 'en_US:en', 12:28:08 INFO - 'LOGNAME': 'cltbld', 12:28:08 INFO - 'MAIL': '/var/mail/cltbld', 12:28:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:08 INFO - 'MOZ_NO_REMOTE': '1', 12:28:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:08 INFO - 'NO_EM_RESTART': '1', 12:28:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:08 INFO - 'PWD': '/builds/slave/test', 12:28:08 INFO - 'SHELL': '/bin/bash', 12:28:08 INFO - 'SHLVL': '1', 12:28:08 INFO - 'TERM': 'linux', 12:28:08 INFO - 'TMOUT': '86400', 12:28:08 INFO - 'USER': 'cltbld', 12:28:08 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', 12:28:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:08 INFO - '_': '/tools/buildbot/bin/python'} 12:28:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:08 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 12:28:08 INFO - Cleaning up... 12:28:08 INFO - Return code: 0 12:28:08 INFO - Running post-action listener: _resource_record_post_action 12:28:08 INFO - Running post-action listener: _start_resource_monitoring 12:28:08 INFO - Starting resource monitoring. 12:28:08 INFO - ##### 12:28:08 INFO - ##### Finished create-virtualenv step (success) 12:28:08 INFO - ##### 12:28:08 INFO - ##### 12:28:08 INFO - ##### Running install step. 12:28:08 INFO - ##### 12:28:08 INFO - Running pre-action listener: _resource_record_pre_action 12:28:08 INFO - Running main action method: install 12:28:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:28:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:28:09 INFO - Reading from file tmpfile_stdout 12:28:09 INFO - Detecting whether we're running mozinstall >=1.0... 12:28:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 12:28:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 12:28:09 INFO - Reading from file tmpfile_stdout 12:28:09 INFO - Output received: 12:28:09 INFO - Usage: mozinstall [options] installer 12:28:09 INFO - Options: 12:28:09 INFO - -h, --help show this help message and exit 12:28:09 INFO - -d DEST, --destination=DEST 12:28:09 INFO - Directory to install application into. [default: 12:28:09 INFO - "/builds/slave/test"] 12:28:09 INFO - --app=APP Application being installed. [default: firefox] 12:28:09 INFO - mkdir: /builds/slave/test/build/application 12:28:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 12:28:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 12:28:26 INFO - Reading from file tmpfile_stdout 12:28:26 INFO - Output received: 12:28:26 INFO - /builds/slave/test/build/application/firefox/firefox 12:28:26 INFO - Running post-action listener: _resource_record_post_action 12:28:26 INFO - ##### 12:28:26 INFO - ##### Finished install step (success) 12:28:26 INFO - ##### 12:28:26 INFO - ##### 12:28:26 INFO - ##### Running run-tests step. 12:28:26 INFO - ##### 12:28:26 INFO - Running pre-action listener: _resource_record_pre_action 12:28:26 INFO - Running main action method: run_tests 12:28:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 12:28:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 12:28:26 INFO - Python 2.7.3 12:28:26 INFO - Return code: 0 12:28:26 INFO - grabbing minidump binary from tooltool 12:28:26 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:28:26 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 0x2771570>, '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 0x2772470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2772900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 12:28:26 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 12:28:26 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 12:28:26 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 12:28:26 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:28:26 INFO - Return code: 0 12:28:26 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 12:28:26 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 12:28:26 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 12:28:26 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 12:28:26 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 12:28:26 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-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-043', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 12:28:26 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-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-043 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 12:28:26 INFO - Using env: {'DISPLAY': ':0', 12:28:26 INFO - 'HOME': '/home/cltbld', 12:28:26 INFO - 'LANG': 'en_US.UTF-8', 12:28:26 INFO - 'LANGUAGE': 'en_US:en', 12:28:26 INFO - 'LOGNAME': 'cltbld', 12:28:26 INFO - 'MAIL': '/var/mail/cltbld', 12:28:26 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:28:26 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:28:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:26 INFO - 'MOZ_NO_REMOTE': '1', 12:28:26 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:28:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:26 INFO - 'NO_EM_RESTART': '1', 12:28:26 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:26 INFO - 'PWD': '/builds/slave/test', 12:28:26 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:28:26 INFO - 'SHELL': '/bin/bash', 12:28:26 INFO - 'SHLVL': '1', 12:28:26 INFO - 'TERM': 'linux', 12:28:26 INFO - 'TMOUT': '86400', 12:28:26 INFO - 'USER': 'cltbld', 12:28:26 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1468610853.781037-210783091', 12:28:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:26 INFO - '_': '/tools/buildbot/bin/python'} 12:28:26 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-043', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 12:28:26 INFO - mozversion application_buildid: 20160715101139 12:28:26 INFO - mozversion application_changeset: 4e3c16ea8fced03ab4ef572f16d4aa4464981e2c 12:28:26 INFO - mozversion application_display_name: Nightly 12:28:26 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:28:26 INFO - mozversion application_name: Firefox 12:28:26 INFO - mozversion application_remotingname: firefox 12:28:26 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 12:28:26 INFO - mozversion application_vendor: Mozilla 12:28:26 INFO - mozversion application_version: 50.0a1 12:28:26 INFO - mozversion platform_buildid: 20160715101139 12:28:26 INFO - mozversion platform_changeset: 4e3c16ea8fced03ab4ef572f16d4aa4464981e2c 12:28:26 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 12:28:26 INFO - mozversion platform_version: 50.0a1 12:28:26 INFO - using testdate: 1468610906 12:28:26 INFO - actual date: 1468610906 12:28:26 INFO - starting webserver on 'localhost:51071' 12:28:26 INFO - SUITE-START | Running 2 tests 12:28:26 INFO - TEST-START | dromaeo_css 12:28:26 INFO - operating with platform_type : linux_ 12:28:26 INFO - Initialising browser for dromaeo_css test... 12:28:26 INFO - TEST-INFO | started process 18275 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHTtTj_/profile http://localhost:51071/getInfo.html) 12:28:31 INFO - PROCESS | 18275 | __metrics Screen width/height:1600/1200 12:28:31 INFO - PROCESS | 18275 | colorDepth:24 12:28:31 INFO - PROCESS | 18275 | Browser inner width/height: 1024/697 12:28:31 INFO - PROCESS | 18275 | __metrics 12:28:32 ERROR - PROCESS | 18275 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2957: TypeError: this.tabs is undefined 12:28:33 INFO - TEST-INFO | 18275: exit 0 12:28:33 INFO - Browser initialized. 12:28:33 INFO - Running cycle 1/1 for dromaeo_css test... 12:28:33 INFO - TEST-INFO | started process 18398 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHTtTj_/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:28:45 INFO - PROCESS | 18398 | RSS: Main: 167849984 12:28:45 INFO - PROCESS | 18398 | 12:29:34 INFO - PROCESS | 18398 | 1468610974644 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] 12:31:43 INFO - PROCESS | 18398 | Cycle 1(1): loaded http://localhost:51071/tests/dromaeo/cssquery-dojo.html (next: http://localhost:51071/tests/dromaeo/cssquery-ext.html) 12:31:44 INFO - PROCESS | 18398 | RSS: Main: 170622976 12:31:44 INFO - PROCESS | 18398 | 12:34:46 INFO - PROCESS | 18398 | Cycle 1(1): loaded http://localhost:51071/tests/dromaeo/cssquery-ext.html (next: http://localhost:51071/tests/dromaeo/cssquery-jquery.html) 12:34:47 INFO - PROCESS | 18398 | RSS: Main: 167575552 12:34:47 INFO - PROCESS | 18398 | 12:37:49 INFO - PROCESS | 18398 | Cycle 1(1): loaded http://localhost:51071/tests/dromaeo/cssquery-jquery.html (next: http://localhost:51071/tests/dromaeo/cssquery-mootools.html) 12:37:49 INFO - PROCESS | 18398 | RSS: Main: 171720704 12:37:49 INFO - PROCESS | 18398 | 12:40:51 INFO - PROCESS | 18398 | Cycle 1(1): loaded http://localhost:51071/tests/dromaeo/cssquery-mootools.html (next: http://localhost:51071/tests/dromaeo/cssquery-prototype.html) 12:40:52 INFO - PROCESS | 18398 | RSS: Main: 166944768 12:40:52 INFO - PROCESS | 18398 | 12:43:54 INFO - PROCESS | 18398 | Cycle 1(1): loaded http://localhost:51071/tests/dromaeo/cssquery-prototype.html (next: http://localhost:51071/tests/dromaeo/cssquery-yui.html) 12:43:55 INFO - PROCESS | 18398 | RSS: Main: 169312256 12:43:55 INFO - PROCESS | 18398 | 12:46:58 INFO - PROCESS | 18398 | Cycle 1(1): loaded http://localhost:51071/tests/dromaeo/cssquery-yui.html (next: http://localhost:51071/tests/dromaeo/cssquery-dojo.html) 12:46:58 INFO - PROCESS | 18398 | RSS: Main: 170094592 12:46:58 INFO - PROCESS | 18398 | 12:46:58 INFO - PROCESS | 18398 | __start_tp_report 12:46:58 INFO - PROCESS | 18398 | _x_x_mozilla_page_load 12:46:58 INFO - PROCESS | 18398 | _x_x_mozilla_page_load_details 12:46:58 INFO - PROCESS | 18398 | |i|pagename|runs| 12:46:58 INFO - PROCESS | 18398 | |0;dojo.html;3100.317930055387;3119.6724343943893;3127.7341425978775;3133.5143052826793;3134.279115803365;5494.230807686927;5510;5520.806771762989;5585.832425027245;5596.160575913615;5472.452754724525;5499.450054994499;5562.082256427685;5568.805091821787;5647.152927060943;4908.8281910133155;4925.335079764231;4985.975070124644;5060.39275286966;5078.949210507903;4926.261060840885;5083.847484575469;5095.184770436731;5118.3857937047605;5122.769475373599;4947.307376967192;5006.949930500721;5016.272640467112;5023.949760502384;5026;5025.597952163818;5028.698278103326;5044.218146187347;5049.166887463564;5099.796008159669;5007.073691367109;5013.423456302536;5031.949680503185;5056.292119103328;5061.822836200752;5415.783368665248;5418.051840927822;5454.290942177531;5499.807506737245;5517.227588137664;5861.5603829712945;5875.412458754133;5882.323532793741;5889.617174883619;5891.351951285355;5787.681677507735;5812.418758124196;5927.7925272615685;5929.762809487615;5934.37689042653;5421.539169170585;5444.40111587725;5446.836594902159;5457.345118585756;5524.8342549723175;5973.044312909914;5985.132155837379;5985.700714964234;6001.789937352171;6015.669138197353;5689.857753556194;5771.59598828078;5798.536117110621;5815.5929084963645;5844.795432159854;5874.941250587525;5875.529957603381;5886;5914.792982245601;5922.615030023035;5704.11586204139;5821.912671309934;5896.056630939029;5905.527557795366;5916.822495325147;5718.79984200551;5854.18041474194;5899.174115623816;5930;5938.762449502058;4500.662450316239;4523.5024147343765;4527.637788976874;4562.954370456253;4568;3984.601539845992;3992.341263691458;4006;4013.7591744495426;4031.314676505001;5562.415946325658;5572.442755724476;5626.774929002876;5659.405762394971;5683.801066962719;5952.404759524013;5973.970130149321;5978.461938425563;5978.581499295007;5978.730957106941;5605.607607467438;5613.550915926716;5615.129654903497;5620.409856965041;5624.072028115315;4860.902781944412;4924.8768780780765;4970.204767237297;4981;4982.9252561211615;6096.756129754849;6156.261248650101;6159.5072394208355;6170;6171.722272497748;5813.534917206698;6004.339522652417;6004.519638429003;6007.12896629995;6018.969905150446;6051.394860513913;6057.242844644419;6085.148079268817;6122.032447070661;6138.846528836815;5832.445917637818;5833.7666493341485;5834.94165058344;5839.941600583939;5885.911711324419;5836.649801011953;5912.793052243151;5934.258217722785;5935.376785437467;5978.850528736816;5723.284589426322;5736.397678243724;5797.855053623524;5816.534677225727;5844.415558444121;5751.33859606134;5766.826995190151;5817.912731308949;5828.912566311594;5832.620879642979;5714.857128571819;5721.685307307972;5734.827955161351;5762.962666720031;5763.769449222152;5686.374498805046;5719.256496655408;5824.650520968756;5846.56150788684;5891.764329426775;5696.829095127153;5711.485966263056;5731.312242530923;5731.598788084961;5752.395998420273 12:46:58 INFO - PROCESS | 18398 | |1;ext.html;560.5375565158743;589.551940525201;599.9730012149453;614.0788816774837;624.5503237668883;38642.806785966066;41990.99999999996;42008.369874451906;42046.7897660512;42154.57845421545;41037.58962410375;41199.38200926981;41345.7932710336;41372.58627413725;41515.16969660613;8554.572271386422;8677.088905664908;8707.434016788888;8792.560371981408;8802.559872006406;8566.785830354229;8693.782655433633;8701.43440676354;8703.912960870373;8711.825763484727;8664.913350866475;8698.608562614698;8746.212840844322;8757.211850933414;8777.2100510954;8607.61265743043;8649.913500865005;8657.307415406784;8683.088275731021;8718.389712720113;8640.049594544658;8652.091530389282;8702;8724.38929274951;8731.912680873173;38871.61128388708;38973.61026389728;39292;39348.60651393478;39522.80238598817;3484.4947482615135;3522.7886326820217;3574.857005719768;3765.8493660253557;4168.7290326128705;32527.6747232527;32561.837190813894;32951.6704832951;33089.33821323584;33965.32069358624;4283.678724095674;4368.563143685637;4369.4319738434115;4514.683972121953;4553.453585569753;355545;355837;355990;356021;356114;34013;58735;58768.11847822286;58848.41151588515;58994.410055898894;34187.316253674784;36314.45528317078;36573.63426365756;36674.63325366766;36754.81622591923;15270.31283592241;15286.159261240517;15375.308111135026;15438.9228053859;15450;13153.671158221121;13165.868341316464;13189.208647481182;13222.867771322357;13248.602541923758;8195;8220.876686849702;8242.876356854653;8298.460600060977;8345.457545259538;3241.594800649919;3256.299895522474;3262.1844538865284;3273.214428537134;3277.443214473154;978.3542861711236;1021.2851004297022;1033.3541536539663;1063.3726101600093;1088.2654208409451;30760;32441;32462.513062304086;32566.511502327485;32928.67071329304;1123.2867129372744;1146.5643055638805;1177.1112809828526;1182.9645110646695;1226.3071364678929;16133.596660083356;16355.509334719978;16547.338106475847;16757.91621041887;16810.411635592696;535631;539663;545439;545700;546811;58138;58356;58719;59030.11454828181;59181.112283315786;1358.7078778062764;1377.5660666889898;1386.7919812028276;1401.7804510076298;1408.8379836318954;30427;31271.687283126877;31313.530297046018;31411.528827067155;32094;49519;50364.74817625889;50429.74785126198;50762;50771;463634;469603;472095;472674;472872;27324.590131148445;27748.583771243044;27925.44149117047;27930.58104128399;27947.720522794512;47002.29496557486;47972.52027479681;48068;48951.75524122357;49084;40803.59196408117;41540.71281529896;41685.374719378626;42648.36027459529;42916.570834291255;41231.381529276485;41948.79025604852;42129.76981766995;42159;43044.56955430531;39231.80384098061;40677.389839151845;41493.79253103715;41532.58467415287;41574.1685166301;34854.477182842784;36252.81873590615;36771.44842827413;37063.81468092642;37328.25343493061;28230.43539129247;28304.15087547377;28544.85727571349;28595.42809143764;28739.13782586526 12:46:58 INFO - PROCESS | 18398 | |2;jquery.html;398.631266078877;398.76871414579546;403.35463258785944;406.0964354311656;416.88535652695526;18368;19952.60094798103;20030.49923751907;20245.190192392285;20251;19165.904170479127;19567.706484402745;19690.409287721355;19714.112864921077;19771.406857794253;5432.375276843174;5641.407652196522;5673.404292549264;5728.140778883159;5797.65214087154;5659.5755318351285;5716.857078573027;5738.368779434259;5762.6254293471;5764.769409223626;5731.484166425021;5747.540196784268;5851.912221316684;5935.10973353996;5981.222441082653;5854.502367298764;5955.731992060346;5989.55078369124;5991.221141251653;5997.250343707036;5585.469380408855;5637.8590535236535;5767.480926716616;5780.971095144498;5843.941560584425;14392.424303027867;14417.207053612046;19965.800341996684;23637.527249455088;24018;2342.417805965243;2355.4817940053163;2438.0979037755965;2949.587057811908;2981.4633365994114;10265.794684106277;10431.21765867563;10472.954539818022;10757.946210268978;14786.63033424173;1963.234338607944;2013.2651582172548;2025.1899240303849;2036.9185232590678;2057.9794202058088;85919.14080859174;86462.70305945478;87503.12496875077;88590.11409885947;89960;10736.838947415796;10801;10998.450077496092;11245.606403775992;11289.209755317213;15378.231088445533;15392.923035384976;15438.228088595526;15461.5311545403;15497.225138743017;8149;8374.41379103469;8413.074561798197;8527.360447966428;8551.273141782895;7898.684052637945;7967;8071.798205044921;8091.838163236703;8116.6347514362;4713.316569097462;4750.311204875274;4764.475907650156;4791.257355109963;4820.68665536739;1974.664307067802;1981.3857704111483;2028.6247044296852;2033.1968872295656;2047.4164863013968;946.3470205558281;977.7360112769512;1026.10728666061;1031.1956673794452;1044.5090807320548;19535.120919558653;19806.70289945652;19874.403767886986;19974.400767976986;20066.297679581145;1002.5839276700234;1013.4122209118841;1049.9317544359592;1055.2454994678842;1058.0371861605902;10499.370037797757;10951.4524273786;10962.177836662282;10973.286736362112;11032.28290161137;482557;486406;491302;491827;492616;92608;94359.05640943503;94946.0505394951;95005;96924.51537742266;998.8052329795765;1003.3377970539409;1012.9240306976859;1013.7313611892854;1023.5905637744961;17240.310387584355;17475.56311092233;17624.1187940605;17861.374851880642;18199.909000454914;41888.3716744243;42230.577694222666;42309.788451057546;43341;43805.91673625103;59735.40264597299;59822.70088649529;60458;60911;61288.387116128266;8687.91312086871;8767.21095101444;8818.382713210014;8935.687250946186;9024.729258122266;9930.702078937644;13495.730085398041;13732.313384330942;13804.654883627989;13839.446422143405;11606.12954028468;11999.940000299943;12002.75994480123;12046.75906481848;12125.575604853788;11870;11911.043725031726;12015.19772034202;12063.336516491327;12077.214981026205;11970.700732481757;12058.698532536406;12282.795731010041;12292.262464252173;12393.132480726263;8771.684247362946;8786.648534058822;8837.955810221165;8937.28501719848;8967.372283940062;9160.31297652692;11724.120690948042;11865.169438139592;11903.047756179312;12428.254304741744 12:46:58 INFO - PROCESS | 18398 | |3;mootools.html;1483.1016299137102;1501.4219525482688;1657.1548510259763;1765.8675599330054;1786.5801536638887;7676.462647614655;8391.496510209376;8397.748067557975;9011.729648110559;9014.188723014928;8442.788930276745;8682.044975052739;8684.131586841313;8735.257503112243;8761.299096072315;2286.8170546356337;2309.9769002310013;2316.814654827618;2318.0959425823944;2328.1734984080576;2277.5900337939247;2285.02886273334;2302.182725132579;2320.6519022146645;2333.0317918063984;2241.977580224201;2252.1104163855266;2255.8195344372493;2323.256557901472;2324.2562380038394;2280.5324908393904;2286.451251699597;2310.295359915225;2311.4683622766775;2315.5600435917204;2242.6299660555987;2258.119333459952;2258.3563684349883;2259.7175353080866;2261.5363850410627;8854.645814167425;8892.911070889339;8902.510361930155;8917.286617070618;8931.955340223321;5044;5238.79044838206;5263.763130659129;5298.576113910878;5302.045631786277;3288.2272665923488;3411.9488207676904;3466.618671946084;3484.5992710838073;3484.9128771780656;1149.293184691417;1159.3739380734394;1953.8143876331726;2037.4397040813747;2103.5056761661;12038.217515861528;12105.213161144497;12140.15018948674;12187.146899717023;12225.572104976283;4405.471343438808;4451.9554804451545;4560.065186636732;4574.428196475441;4580.358749774968;9571.521423928776;9579.473128977974;9601.37591056593;9605.759856003655;9618;5144;5147.3051138096625;5159.097157997336;5171.01750667372;5187.662801917863;4387.276099443556;4564.863054108382;4718.433787945469;4726.976365118221;4824.734639594856;3699.408094704834;3725.3108174987715;3739.121306492972;3800.3729384651224;3812.694984401241;1155.9711007224719;1217.3304682424632;1223.2843088343861;1224.406163010939;1227.8035514317667;894.5482531321771;995.721198064543;1003.2626019875386;1009.333839665817;1027.3322340478749;5841.591088623755;5865.560082993792;5880.470757631748;6052.485538729257;6056.273247210275;948.8102379523984;949.3164921256684;965.1410244882061;975.22956864078;993.4883534979491;4032.959670403317;4270.978645106817;4388.912221755547;4412.36020776992;4463.620592249695;10581.153507719364;11080.335179889233;11131.666050018512;11197.552097916156;11232.213745037769;10490.947545262377;10920.399378034126;10959.780804384027;11043;11304.49129789145;8171;8177.877331840146;8231;8274.875876861852;8306.54314012723;6013.248343957005;6187.195664563578;6195.938040619536;6253.218347706536;6280.811575652738;10103.848442273225;10126.13927816144;10196.592136314464;10285.331453455501;10299.691009269734;9989;10370.377777333384;10433.269671123253;10453.9477302613;10491.160707143563;7019.08751862275;7614.581198034161;7851.764447066597;7956.283934445928;8062.113167551682;8693.652253909773;8743.256823170103;8772.38593298463;8775.517346546001;8787.25308348772;7686.077670679554;7698.769036928901;7737.14891361961;7759.952406425286;8068.838623227385;7328.5969271690565;7721.073471183494;7868.763937081897;7997.800054998672;8027.036755589366;6709.396154346132;6970.756023539152;6979.546329488567;6982.7206911725;6986.021956926136;4548.704334218265;4634.655532358975;4750.14497390473;4752.477227504903;4815.711057336571;5169.302144210634;5256.947430525645;5354.063038968243;5397.406285308534;5419.376771671308 12:46:58 INFO - PROCESS | 18398 | |4;prototype.html;315.6307120668817;322.04192527231487;324.98442367601245;325.71499937554637;326.4483023689962;5603.215549823023;5631.267935168427;5640.51817200432;5657.349404818437;5657.688827114507;5560.888782224353;5568.387477377495;5571.331440227178;5592.552595792337;5611.270534830476;4084.3260861957815;4175.519815221258;4266.530681625019;4291.6566674665955;4307.440032795732;4257.276263035292;4262.381954616579;4262.403263543107;4262.72292301001;4266.850660226893;4222.429971953778;4237.766922819259;4241.4274073000215;4243.151369726052;4243.642034548946;4035.535913369956;4230.153969206141;4247.0039081631585;4247.214265360887;4290.935635965463;3674.6325367463305;3679.245754620323;3682.8895133146048;3701.648343407372;3714.4799728038097;5450.29146210994;5458.0721277382545;5470.398256191816;5492.890142197134;5528.834134975958;4707.411573553306;4888.242322440027;4935.136351138536;4958.281049247839;4972.552470277692;5808.738606762706;5848.327442344143;5854.297484301868;5857.414258574151;5883.558733095035;4049.2104039712267;4058.918821623551;4125.443065186191;4126.101993083185;4134.751914885116;5930.288365396137;6070.605410648293;6084.117802918597;6101;6127.969360153171;4135.015192707518;4180.435641188462;4182.163567286494;4198.412222288882;4211.536730959592;4230.238557059697;4239.9788001060415;4246.4691913510815;4251.766152861561;4258.68059895509;4623.352730617717;4886.755662216875;4903.215485522299;4925.975370123198;4933.802647894044;5853.414658534198;5858;5874.853128671817;5908.704564771744;5972.46247837688;1459.3214155417782;1466.911985280865;1480.4374337751801;1481.3852251315584;1481.5259117082646;923.6259314977444;932.7201839448138;940.8259471997702;946.8437707778277;947.1712251779693;5500.58745594082;5550.7779688812;5581.302337207849;5604.355499117572;5618.185363122406;5948.762049517971;5953.791617293374;5954.85112872173;5999.730012149464;6062.939370606326;5450.209719590716;5691.516221121251;5733.569982251264;5747.074729965425;5757.251557297608;3219.2455111964036;3224.4357237483346;3235.7411407087375;3245.918852028718;3248.6101667799544;6087.817365479043;6225.221847269091;6242.250929888442;6280.371962803683;6332.810015699536;6101.481374083252;6151.384861513902;6155.599886007395;6165.630062196283;6179.84550386244;6128.233970753656;6224.688765561704;6230.408111229426;6262.749490020348;6267.655278959701;6047.881141988746;6056;6064.939350606437;6084.148219249397;6085.330613632408;5950.553708471795;5960.314563825215;6002.489788367863;6022.397760223943;6025.764718232839;6050.576459647782;6188.907166392598;6217.96891015542;6229.56393052482;6249.78125765596;4073.920411091004;4086.468759061303;4094.897627559335;4127.504699436087;4130.834766609302;5777.62445441045;5788.334341550775;6023.247094113236;6037.69811509414;6063.272407311151;5763.164341170591;5782.5373970081455;5793.536517078539;5800.1299805029585;5801.6519008859605;5816.47651711348;5830.416958304136;5842.970785146217;5847;5886.352501224947;5538.944610553843;5744.712764361849;5760.567957403296;5784.797532086357;5793.391693872083;5808.796692115756;5863.2670916135485;5869;5878.765459253434;5880.823835233056;5432.701201433959;5698.914516282342;5701.657900525982;5715.257016587817;5770.6249093808765 12:46:58 INFO - PROCESS | 18398 | |5;yui.html;623.5541587764748;625.2934184371659;733.2117973178831;747.1557140431312;786.9567173805442;15010.249487525622;16221.513354599367;16307.184640767973;16313.51059468215;16373.345066197367;14095.083819551723;14168.787468187986;14197.71604567908;14213.289335533234;14311.57065288043;792.0495405513378;794.6463823598501;811.123986095016;811.2212276214841;811.7686459359084;785.9724909628164;822.0874828939872;826.1366871619173;826.904905935816;827.7682248970298;863.8013256950906;866.8959724833029;867.5792240763257;869.0744357259498;872.4634349874844;853.7566793463864;855.7689423855586;856.297835774665;856.8543347630949;859.0679113162164;630.706721374563;631.516889579472;631.7915088020942;632.0897907013886;632.822809613309;14330.785038224434;14345.928270358581;14359.856401435956;14459.27703614815;14521.419143234258;14328.64178395538;14340.64148396288;14546.199959002251;14703.852961470462;14724.926375368163;12454.903206276576;12563.18339307942;12606;12919.806202906964;13193.20840749558;3934.252492026506;3947.684185265172;4068.8982775430554;4159.563245859172;4172.728772629769;77765;78791.60604196943;79200.60399698022;79838.60080699559;80414.59792701057;11306;11427.48576314068;11505.367204803648;11597.246178998337;11645.73397587948;21406.892965535073;21432.78567214308;21436;21442;21479.892600536896;8633.568321584022;8888.777780555538;8922.509261990654;9068.954655226682;9210.861837072449;5050.535344749981;5079.873003174876;5179.922301165486;5237.6071794615555;5400.567954563626;3626.2747450510005;3689.4281386385155;3697.759645623026;3740.8129593520216;3749.456328832304;612.2408213814838;625.5589809184605;635.9459445947147;640.8365866704054;656.9770058048041;675.8006388115517;689.3451221339648;696.9581825090511;697.1459961547064;717.7667258141125;9773.267004974514;10235.846462303072;10349.172066234683;10395.32430392022;10450.372977621368;681.6455443169623;767.6775754183257;771.8301973565807;780.9453338266267;790.7509134622576;4599.356090147382;4821.156297647897;4847.781849816767;4861.829835955796;4882.902341953141;110530.44734776275;118865.40567297109;121591.39204303922;121803;122979;103006;105782.47108764407;106440.46779766052;106841.46579267054;107031;79427;87716;88408.5579572098;90546;93158.53420732853;8999.955000224956;9006.86489702668;9157;9162.67930622425;9264.95367523185;44581;51103;51373.50454180722;52036.73981630067;52366.738166308925;67534.66232668805;68744.65627671829;68960.0774787456;74200.25799741934;79681;13650.658733531742;13884.119314778565;14389.568312950629;14555.636109097357;14674.266286685837;15653.452129175424;15693.921530392276;15950.60123496922;16054.277557509706;16499.67000660004;14256.358463869357;14725.410983560538;14768;14799.704005919606;15454.459093931659;13814.102083364549;13914.86085139176;14130.293485325898;14291.356888939814;14831.92584037073;12452.875471245534;13795.79306310386;13812.723745525234;13983.510577130159;14047.578572642837;11904.166708330335;11909.40452977365;12199;12253.938730306292;12441.191322564004;10657.89342106569;10967.561297548009;11464;12223.69440763988;12418.503259869503 12:46:58 INFO - PROCESS | 18398 | __end_tp_report 12:46:58 INFO - PROCESS | 18398 | __start_cc_report 12:46:58 INFO - PROCESS | 18398 | _x_x_mozilla_cycle_collect,369 12:46:58 INFO - PROCESS | 18398 | __end_cc_report 12:46:58 INFO - PROCESS | 18398 | __startTimestamp1468612018302__endTimestamp 12:46:58 INFO - PROCESS | 18398 | 12:46:58 INFO - PROCESS | 18398 | ------- Summary: start ------- 12:46:58 INFO - PROCESS | 18398 | Number of tests: 6 12:46:58 INFO - PROCESS | 18398 | 12:46:58 INFO - PROCESS | 18398 | [#0] dojo.html Cycles:165 Average:5483.12 Median:5719.26 stddev:634.94 (11.1%) stddev-sans-first:608.76 12:46:58 INFO - PROCESS | 18398 | Values: 3100.3 3119.7 3127.7 3133.5 3134.3 5494.2 5510.0 5520.8 5585.8 5596.2 5472.5 5499.5 5562.1 5568.8 5647.2 4908.8 4925.3 4986.0 5060.4 5078.9 4926.3 5083.8 5095.2 5118.4 5122.8 4947.3 5006.9 5016.3 5023.9 5026.0 5025.6 5028.7 5044.2 5049.2 5099.8 5007.1 5013.4 5031.9 5056.3 5061.8 5415.8 5418.1 5454.3 5499.8 5517.2 5861.6 5875.4 5882.3 5889.6 5891.4 5787.7 5812.4 5927.8 5929.8 5934.4 5421.5 5444.4 5446.8 5457.3 5524.8 5973.0 5985.1 5985.7 6001.8 6015.7 5689.9 5771.6 5798.5 5815.6 5844.8 5874.9 5875.5 5886.0 5914.8 5922.6 5704.1 5821.9 5896.1 5905.5 5916.8 5718.8 5854.2 5899.2 5930.0 5938.8 4500.7 4523.5 4527.6 4563.0 4568.0 3984.6 3992.3 4006.0 4013.8 4031.3 5562.4 5572.4 5626.8 5659.4 5683.8 5952.4 5974.0 5978.5 5978.6 5978.7 5605.6 5613.6 5615.1 5620.4 5624.1 4860.9 4924.9 4970.2 4981.0 4982.9 6096.8 6156.3 6159.5 6170.0 6171.7 5813.5 6004.3 6004.5 6007.1 6019.0 6051.4 6057.2 6085.1 6122.0 6138.8 5832.4 5833.8 5834.9 5839.9 5885.9 5836.6 5912.8 5934.3 5935.4 5978.9 5723.3 5736.4 5797.9 5816.5 5844.4 5751.3 5766.8 5817.9 5828.9 5832.6 5714.9 5721.7 5734.8 5763.0 5763.8 5686.4 5719.3 5824.7 5846.6 5891.8 5696.8 5711.5 5731.3 5731.6 5752.4 12:46:58 INFO - PROCESS | 18398 | 12:46:58 INFO - PROCESS | 18398 | [#1] ext.html Cycles:180 Average:60122.38 Median:41288.59 stddev:123051.54 (298.0%) stddev-sans-first:123315.47 12:46:58 INFO - PROCESS | 18398 | Values: 560.5 589.6 600.0 614.1 624.6 38642.8 41991.0 42008.4 42046.8 42154.6 41037.6 41199.4 41345.8 41372.6 41515.2 8554.6 8677.1 8707.4 8792.6 8802.6 8566.8 8693.8 8701.4 8703.9 8711.8 8664.9 8698.6 8746.2 8757.2 8777.2 8607.6 8649.9 8657.3 8683.1 8718.4 8640.0 8652.1 8702.0 8724.4 8731.9 38871.6 38973.6 39292.0 39348.6 39522.8 3484.5 3522.8 3574.9 3765.8 4168.7 32527.7 32561.8 32951.7 33089.3 33965.3 4283.7 4368.6 4369.4 4514.7 4553.5 355545.0 355837.0 355990.0 356021.0 356114.0 34013.0 58735.0 58768.1 58848.4 58994.4 34187.3 36314.5 36573.6 36674.6 36754.8 15270.3 15286.2 15375.3 15438.9 15450.0 13153.7 13165.9 13189.2 13222.9 13248.6 8195.0 8220.9 8242.9 8298.5 8345.5 3241.6 3256.3 3262.2 3273.2 3277.4 978.4 1021.3 1033.4 1063.4 1088.3 30760.0 32441.0 32462.5 32566.5 32928.7 1123.3 1146.6 1177.1 1183.0 1226.3 16133.6 16355.5 16547.3 16757.9 16810.4 535631.0 539663.0 545439.0 545700.0 546811.0 58138.0 58356.0 58719.0 59030.1 59181.1 1358.7 1377.6 1386.8 1401.8 1408.8 30427.0 31271.7 31313.5 31411.5 32094.0 49519.0 50364.7 50429.7 50762.0 50771.0 463634.0 469603.0 472095.0 472674.0 472872.0 27324.6 27748.6 27925.4 27930.6 27947.7 47002.3 47972.5 48068.0 48951.8 49084.0 40803.6 41540.7 41685.4 42648.4 42916.6 41231.4 41948.8 42129.8 42159.0 43044.6 39231.8 40677.4 41493.8 41532.6 41574.2 34854.5 36252.8 36771.4 37063.8 37328.3 28230.4 28304.2 28544.9 28595.4 28739.1 12:46:58 INFO - PROCESS | 18398 | 12:46:58 INFO - PROCESS | 18398 | [#2] jquery.html Cycles:180 Average:29384.48 Median:23827.76 stddev:80824.41 (339.2%) stddev-sans-first:81021.85 12:46:58 INFO - PROCESS | 18398 | Values: 398.6 398.8 403.4 406.1 416.9 18368.0 19952.6 20030.5 20245.2 20251.0 19165.9 19567.7 19690.4 19714.1 19771.4 5432.4 5641.4 5673.4 5728.1 5797.7 5659.6 5716.9 5738.4 5762.6 5764.8 5731.5 5747.5 5851.9 5935.1 5981.2 5854.5 5955.7 5989.6 5991.2 5997.3 5585.5 5637.9 5767.5 5781.0 5843.9 14392.4 14417.2 19965.8 23637.5 24018.0 2342.4 2355.5 2438.1 2949.6 2981.5 10265.8 10431.2 10473.0 10757.9 14786.6 1963.2 2013.3 2025.2 2036.9 2058.0 85919.1 86462.7 87503.1 88590.1 89960.0 10736.8 10801.0 10998.5 11245.6 11289.2 15378.2 15392.9 15438.2 15461.5 15497.2 8149.0 8374.4 8413.1 8527.4 8551.3 7898.7 7967.0 8071.8 8091.8 8116.6 4713.3 4750.3 4764.5 4791.3 4820.7 1974.7 1981.4 2028.6 2033.2 2047.4 946.3 977.7 1026.1 1031.2 1044.5 19535.1 19806.7 19874.4 19974.4 20066.3 1002.6 1013.4 1049.9 1055.2 1058.0 10499.4 10951.5 10962.2 10973.3 11032.3 482557.0 486406.0 491302.0 491827.0 492616.0 92608.0 94359.1 94946.1 95005.0 96924.5 998.8 1003.3 1012.9 1013.7 1023.6 17240.3 17475.6 17624.1 17861.4 18199.9 41888.4 42230.6 42309.8 43341.0 43805.9 59735.4 59822.7 60458.0 60911.0 61288.4 8687.9 8767.2 8818.4 8935.7 9024.7 9930.7 13495.7 13732.3 13804.7 13839.4 11606.1 11999.9 12002.8 12046.8 12125.6 11870.0 11911.0 12015.2 12063.3 12077.2 11970.7 12058.7 12282.8 12292.3 12393.1 8771.7 8786.6 8838.0 8937.3 8967.4 9160.3 11724.1 11865.2 11903.0 12428.3 12:46:58 INFO - PROCESS | 18398 | 12:46:58 INFO - PROCESS | 18398 | [#3] mootools.html Cycles:180 Average:5795.82 Median:4676.54 stddev:3270.57 (69.9%) stddev-sans-first:3263.69 12:46:58 INFO - PROCESS | 18398 | Values: 1483.1 1501.4 1657.2 1765.9 1786.6 7676.5 8391.5 8397.7 9011.7 9014.2 8442.8 8682.0 8684.1 8735.3 8761.3 2286.8 2310.0 2316.8 2318.1 2328.2 2277.6 2285.0 2302.2 2320.7 2333.0 2242.0 2252.1 2255.8 2323.3 2324.3 2280.5 2286.5 2310.3 2311.5 2315.6 2242.6 2258.1 2258.4 2259.7 2261.5 8854.6 8892.9 8902.5 8917.3 8932.0 5044.0 5238.8 5263.8 5298.6 5302.0 3288.2 3411.9 3466.6 3484.6 3484.9 1149.3 1159.4 1953.8 2037.4 2103.5 12038.2 12105.2 12140.2 12187.1 12225.6 4405.5 4452.0 4560.1 4574.4 4580.4 9571.5 9579.5 9601.4 9605.8 9618.0 5144.0 5147.3 5159.1 5171.0 5187.7 4387.3 4564.9 4718.4 4727.0 4824.7 3699.4 3725.3 3739.1 3800.4 3812.7 1156.0 1217.3 1223.3 1224.4 1227.8 894.5 995.7 1003.3 1009.3 1027.3 5841.6 5865.6 5880.5 6052.5 6056.3 948.8 949.3 965.1 975.2 993.5 4033.0 4271.0 4388.9 4412.4 4463.6 10581.2 11080.3 11131.7 11197.6 11232.2 10490.9 10920.4 10959.8 11043.0 11304.5 8171.0 8177.9 8231.0 8274.9 8306.5 6013.2 6187.2 6195.9 6253.2 6280.8 10103.8 10126.1 10196.6 10285.3 10299.7 9989.0 10370.4 10433.3 10453.9 10491.2 7019.1 7614.6 7851.8 7956.3 8062.1 8693.7 8743.3 8772.4 8775.5 8787.3 7686.1 7698.8 7737.1 7760.0 8068.8 7328.6 7721.1 7868.8 7997.8 8027.0 6709.4 6970.8 6979.5 6982.7 6986.0 4548.7 4634.7 4750.1 4752.5 4815.7 5169.3 5256.9 5354.1 5397.4 5419.4 12:46:58 INFO - PROCESS | 18398 | 12:46:58 INFO - PROCESS | 18398 | [#4] prototype.html Cycles:180 Average:4899.50 Median:5648.93 stddev:1474.25 (26.1%) stddev-sans-first:1437.68 12:46:58 INFO - PROCESS | 18398 | Values: 315.6 322.0 325.0 325.7 326.4 5603.2 5631.3 5640.5 5657.3 5657.7 5560.9 5568.4 5571.3 5592.6 5611.3 4084.3 4175.5 4266.5 4291.7 4307.4 4257.3 4262.4 4262.4 4262.7 4266.9 4222.4 4237.8 4241.4 4243.2 4243.6 4035.5 4230.2 4247.0 4247.2 4290.9 3674.6 3679.2 3682.9 3701.6 3714.5 5450.3 5458.1 5470.4 5492.9 5528.8 4707.4 4888.2 4935.1 4958.3 4972.6 5808.7 5848.3 5854.3 5857.4 5883.6 4049.2 4058.9 4125.4 4126.1 4134.8 5930.3 6070.6 6084.1 6101.0 6128.0 4135.0 4180.4 4182.2 4198.4 4211.5 4230.2 4240.0 4246.5 4251.8 4258.7 4623.4 4886.8 4903.2 4926.0 4933.8 5853.4 5858.0 5874.9 5908.7 5972.5 1459.3 1466.9 1480.4 1481.4 1481.5 923.6 932.7 940.8 946.8 947.2 5500.6 5550.8 5581.3 5604.4 5618.2 5948.8 5953.8 5954.9 5999.7 6062.9 5450.2 5691.5 5733.6 5747.1 5757.3 3219.2 3224.4 3235.7 3245.9 3248.6 6087.8 6225.2 6242.3 6280.4 6332.8 6101.5 6151.4 6155.6 6165.6 6179.8 6128.2 6224.7 6230.4 6262.7 6267.7 6047.9 6056.0 6064.9 6084.1 6085.3 5950.6 5960.3 6002.5 6022.4 6025.8 6050.6 6188.9 6218.0 6229.6 6249.8 4073.9 4086.5 4094.9 4127.5 4130.8 5777.6 5788.3 6023.2 6037.7 6063.3 5763.2 5782.5 5793.5 5800.1 5801.7 5816.5 5830.4 5843.0 5847.0 5886.4 5538.9 5744.7 5760.6 5784.8 5793.4 5808.8 5863.3 5869.0 5878.8 5880.8 5432.7 5698.9 5701.7 5715.3 5770.6 12:46:58 INFO - PROCESS | 18398 | 12:46:58 INFO - PROCESS | 18398 | [#5] yui.html Cycles:180 Average:21342.50 Median:4008.29 stddev:30854.50 (769.8%) stddev-sans-first:30901.84 12:46:58 INFO - PROCESS | 18398 | Values: 623.6 625.3 733.2 747.2 787.0 15010.2 16221.5 16307.2 16313.5 16373.3 14095.1 14168.8 14197.7 14213.3 14311.6 792.0 794.6 811.1 811.2 811.8 786.0 822.1 826.1 826.9 827.8 863.8 866.9 867.6 869.1 872.5 853.8 855.8 856.3 856.9 859.1 630.7 631.5 631.8 632.1 632.8 14330.8 14345.9 14359.9 14459.3 14521.4 14328.6 14340.6 14546.2 14703.9 14724.9 12454.9 12563.2 12606.0 12919.8 13193.2 3934.3 3947.7 4068.9 4159.6 4172.7 77765.0 78791.6 79200.6 79838.6 80414.6 11306.0 11427.5 11505.4 11597.2 11645.7 21406.9 21432.8 21436.0 21442.0 21479.9 8633.6 8888.8 8922.5 9069.0 9210.9 5050.5 5079.9 5179.9 5237.6 5400.6 3626.3 3689.4 3697.8 3740.8 3749.5 612.2 625.6 635.9 640.8 657.0 675.8 689.3 697.0 697.1 717.8 9773.3 10235.8 10349.2 10395.3 10450.4 681.6 767.7 771.8 780.9 790.8 4599.4 4821.2 4847.8 4861.8 4882.9 110530.4 118865.4 121591.4 121803.0 122979.0 103006.0 105782.5 106440.5 106841.5 107031.0 79427.0 87716.0 88408.6 90546.0 93158.5 9000.0 9006.9 9157.0 9162.7 9265.0 44581.0 51103.0 51373.5 52036.7 52366.7 67534.7 68744.7 68960.1 74200.3 79681.0 13650.7 13884.1 14389.6 14555.6 14674.3 15653.5 15693.9 15950.6 16054.3 16499.7 14256.4 14725.4 14768.0 14799.7 15454.5 13814.1 13914.9 14130.3 14291.4 14831.9 12452.9 13795.8 13812.7 13983.5 14047.6 11904.2 11909.4 12199.0 12253.9 12441.2 10657.9 10967.6 11464.0 12223.7 12418.5 12:46:58 INFO - PROCESS | 18398 | -------- Summary: end -------- 12:46:58 INFO - PROCESS | 18398 | 12:46:59 INFO - TEST-INFO | 18398: exit 0 12:46:59 INFO - TEST-OK | dromaeo_css | took 1112417ms 12:46:59 INFO - TEST-START | kraken 12:46:59 INFO - operating with platform_type : linux_ 12:46:59 INFO - Initialising browser for kraken test... 12:46:59 INFO - TEST-INFO | started process 18646 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpI3GLqg/profile http://localhost:51071/getInfo.html) 12:47:04 INFO - PROCESS | 18646 | __metrics Screen width/height:1600/1200 12:47:04 INFO - PROCESS | 18646 | colorDepth:24 12:47:04 INFO - PROCESS | 18646 | Browser inner width/height: 1024/697 12:47:04 INFO - PROCESS | 18646 | __metrics 12:47:04 ERROR - PROCESS | 18646 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2957: TypeError: this.tabs is undefined 12:47:05 INFO - TEST-INFO | 18646: exit 0 12:47:05 INFO - Browser initialized. 12:47:05 INFO - Running cycle 1/1 for kraken test... 12:47:05 INFO - TEST-INFO | started process 18769 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpI3GLqg/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:47:17 INFO - PROCESS | 18769 | RSS: Main: 167391232 12:47:17 INFO - PROCESS | 18769 | 12:47:19 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:51071/tests/kraken/driver.html?testName=audio-beat-detection) 12:47:20 INFO - PROCESS | 18769 | RSS: Main: 172552192 12:47:20 INFO - PROCESS | 18769 | 12:47:23 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:51071/tests/kraken/driver.html?testName=audio-dft) 12:47:23 INFO - PROCESS | 18769 | RSS: Main: 172232704 12:47:23 INFO - PROCESS | 18769 | 12:47:26 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:51071/tests/kraken/driver.html?testName=audio-fft) 12:47:27 INFO - PROCESS | 18769 | RSS: Main: 166834176 12:47:27 INFO - PROCESS | 18769 | 12:47:29 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:51071/tests/kraken/driver.html?testName=audio-oscillator) 12:47:30 INFO - PROCESS | 18769 | RSS: Main: 168275968 12:47:30 INFO - PROCESS | 18769 | 12:47:32 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:51071/tests/kraken/driver.html?testName=imaging-gaussian-blur) 12:47:32 INFO - PROCESS | 18769 | RSS: Main: 168550400 12:47:32 INFO - PROCESS | 18769 | 12:47:36 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:51071/tests/kraken/driver.html?testName=imaging-darkroom) 12:47:36 INFO - PROCESS | 18769 | RSS: Main: 168144896 12:47:36 INFO - PROCESS | 18769 | 12:47:40 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:51071/tests/kraken/driver.html?testName=imaging-desaturate) 12:47:40 INFO - PROCESS | 18769 | RSS: Main: 166658048 12:47:40 INFO - PROCESS | 18769 | 12:47:43 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:51071/tests/kraken/driver.html?testName=json-parse-financial) 12:47:44 INFO - PROCESS | 18769 | RSS: Main: 167538688 12:47:44 INFO - PROCESS | 18769 | 12:47:45 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:51071/tests/kraken/driver.html?testName=json-stringify-tinderbox) 12:47:46 INFO - PROCESS | 18769 | RSS: Main: 167800832 12:47:46 INFO - PROCESS | 18769 | 12:47:48 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:51071/tests/kraken/driver.html?testName=stanford-crypto-aes) 12:47:48 INFO - PROCESS | 18769 | RSS: Main: 168411136 12:47:48 INFO - PROCESS | 18769 | 12:47:50 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:51071/tests/kraken/driver.html?testName=stanford-crypto-ccm) 12:47:51 INFO - PROCESS | 18769 | RSS: Main: 168538112 12:47:51 INFO - PROCESS | 18769 | 12:47:54 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:51071/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 12:47:54 INFO - PROCESS | 18769 | RSS: Main: 168611840 12:47:54 INFO - PROCESS | 18769 | 12:47:57 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:51071/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 12:47:58 INFO - PROCESS | 18769 | RSS: Main: 168411136 12:47:58 INFO - PROCESS | 18769 | 12:47:59 INFO - PROCESS | 18769 | Cycle 1(1): loaded http://localhost:51071/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:51071/tests/kraken/driver.html?testName=ai-astar) 12:48:00 INFO - PROCESS | 18769 | RSS: Main: 169672704 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | __start_tp_report 12:48:00 INFO - PROCESS | 18769 | _x_x_mozilla_page_load 12:48:00 INFO - PROCESS | 18769 | _x_x_mozilla_page_load_details 12:48:00 INFO - PROCESS | 18769 | |i|pagename|runs| 12:48:00 INFO - PROCESS | 18769 | |0;ai-astar;102;111;108;111;115;112;111;112;113;110 12:48:00 INFO - PROCESS | 18769 | |1;audio-beat-detection;152;117;149;173;119;148;147;126;184;117 12:48:00 INFO - PROCESS | 18769 | |2;audio-dft;162;163;163;162;163;163;167;167;162;165 12:48:00 INFO - PROCESS | 18769 | |3;audio-fft;76;74;75;158;79;79;74;75;183;76 12:48:00 INFO - PROCESS | 18769 | |4;audio-oscillator;86;84;166;85;84;84;144;84;85;158 12:48:00 INFO - PROCESS | 18769 | |5;imaging-gaussian-blur;118;117;118;117;118;118;118;117;117;118 12:48:00 INFO - PROCESS | 18769 | |6;imaging-darkroom;146;147;146;147;147;147;147;147;147;147 12:48:00 INFO - PROCESS | 18769 | |7;imaging-desaturate;96;96;95;95;95;96;96;96;95;95 12:48:00 INFO - PROCESS | 18769 | |8;json-parse-financial;52;55;54;54;55;53;55;58;56;58 12:48:00 INFO - PROCESS | 18769 | |9;json-stringify-tinderbox;63;64;62;63;63;63;62;63;62;63 12:48:00 INFO - PROCESS | 18769 | |10;stanford-crypto-aes;77;82;77;81;77;76;76;81;81;76 12:48:00 INFO - PROCESS | 18769 | |11;stanford-crypto-ccm;134;133;133;134;128;130;126;126;162;123 12:48:00 INFO - PROCESS | 18769 | |12;stanford-crypto-pbkdf2;158;156;159;157;155;157;160;163;160;162 12:48:00 INFO - PROCESS | 18769 | |13;stanford-crypto-sha256-iterative;64;63;64;65;64;62;63;63;64;64 12:48:00 INFO - PROCESS | 18769 | __end_tp_report 12:48:00 INFO - PROCESS | 18769 | __start_cc_report 12:48:00 INFO - PROCESS | 18769 | _x_x_mozilla_cycle_collect,939 12:48:00 INFO - PROCESS | 18769 | __end_cc_report 12:48:00 INFO - PROCESS | 18769 | __startTimestamp1468612080145__endTimestamp 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | ------- Summary: start ------- 12:48:00 INFO - PROCESS | 18769 | Number of tests: 14 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#0] ai-astar Cycles:10 Average:110.50 Median:111.50 stddev:3.50 (3.1%) stddev-sans-first:1.94 12:48:00 INFO - PROCESS | 18769 | Values: 102.0 111.0 108.0 111.0 115.0 112.0 111.0 112.0 113.0 110.0 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#1] audio-beat-detection Cycles:10 Average:143.20 Median:148.50 stddev:23.47 (15.8%) stddev-sans-first:24.67 12:48:00 INFO - PROCESS | 18769 | Values: 152.0 117.0 149.0 173.0 119.0 148.0 147.0 126.0 184.0 117.0 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#2] audio-dft Cycles:10 Average:163.70 Median:163.00 stddev:1.95 (1.2%) stddev-sans-first:1.96 12:48:00 INFO - PROCESS | 18769 | Values: 162.0 163.0 163.0 162.0 163.0 163.0 167.0 167.0 162.0 165.0 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#3] audio-fft Cycles:10 Average:94.90 Median:75.50 stddev:40.32 (53.4%) stddev-sans-first:42.18 12:48:00 INFO - PROCESS | 18769 | Values: 76.0 74.0 75.0 158.0 79.0 79.0 74.0 75.0 183.0 76.0 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#4] audio-oscillator Cycles:10 Average:106.00 Median:84.00 stddev:34.91 (41.6%) stddev-sans-first:36.27 12:48:00 INFO - PROCESS | 18769 | Values: 86.0 84.0 166.0 85.0 84.0 84.0 144.0 84.0 85.0 158.0 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#5] imaging-gaussian-blur Cycles:10 Average:117.60 Median:118.00 stddev:0.52 (0.4%) stddev-sans-first:0.53 12:48:00 INFO - PROCESS | 18769 | Values: 118.0 117.0 118.0 117.0 118.0 118.0 118.0 117.0 117.0 118.0 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#6] imaging-darkroom Cycles:10 Average:146.80 Median:147.00 stddev:0.42 (0.3%) stddev-sans-first:0.33 12:48:00 INFO - PROCESS | 18769 | Values: 146.0 147.0 146.0 147.0 147.0 147.0 147.0 147.0 147.0 147.0 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#7] imaging-desaturate Cycles:10 Average:95.50 Median:96.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 12:48:00 INFO - PROCESS | 18769 | Values: 96.0 96.0 95.0 95.0 95.0 96.0 96.0 96.0 95.0 95.0 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#8] json-parse-financial Cycles:10 Average:55.00 Median:55.00 stddev:1.94 (3.5%) stddev-sans-first:1.73 12:48:00 INFO - PROCESS | 18769 | Values: 52.0 55.0 54.0 54.0 55.0 53.0 55.0 58.0 56.0 58.0 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#9] json-stringify-tinderbox Cycles:10 Average:62.80 Median:63.00 stddev:0.63 (1.0%) stddev-sans-first:0.67 12:48:00 INFO - PROCESS | 18769 | Values: 63.0 64.0 62.0 63.0 63.0 63.0 62.0 63.0 62.0 63.0 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#10] stanford-crypto-aes Cycles:10 Average:78.40 Median:79.00 stddev:2.50 (3.2%) stddev-sans-first:2.60 12:48:00 INFO - PROCESS | 18769 | Values: 77.0 82.0 77.0 81.0 77.0 76.0 76.0 81.0 81.0 76.0 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#11] stanford-crypto-ccm Cycles:10 Average:132.90 Median:133.00 stddev:10.93 (8.2%) stddev-sans-first:11.58 12:48:00 INFO - PROCESS | 18769 | Values: 134.0 133.0 133.0 134.0 128.0 130.0 126.0 126.0 162.0 123.0 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:158.70 Median:159.50 stddev:2.58 (1.6%) stddev-sans-first:2.73 12:48:00 INFO - PROCESS | 18769 | Values: 158.0 156.0 159.0 157.0 155.0 157.0 160.0 163.0 160.0 162.0 12:48:00 INFO - PROCESS | 18769 | 12:48:00 INFO - PROCESS | 18769 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.60 Median:64.00 stddev:0.84 (1.3%) stddev-sans-first:0.88 12:48:00 INFO - PROCESS | 18769 | Values: 64.0 63.0 64.0 65.0 64.0 62.0 63.0 63.0 64.0 64.0 12:48:00 INFO - PROCESS | 18769 | -------- Summary: end -------- 12:48:00 INFO - PROCESS | 18769 | 12:48:01 INFO - TEST-INFO | 18769: exit 0 12:48:01 INFO - TEST-OK | kraken | took 62011ms 12:48:01 INFO - SUITE-END | took 1174s 12:48:01 INFO - Completed test suite (00:19:34) 12:48:01 INFO - javascript benchmark 12:48:01 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7325.758074510823, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3100.317930055387, 3119.6724343943893, 3127.7341425978775, 3133.5143052826793, 3134.279115803365, 5494.230807686927, 5510.0, 5520.806771762989, 5585.832425027245, 5596.160575913615, 5472.452754724525, 5499.450054994499, 5562.082256427685, 5568.805091821787, 5647.152927060943, 4908.8281910133155, 4925.335079764231, 4985.975070124644, 5060.39275286966, 5078.949210507903, 4926.261060840885, 5083.847484575469, 5095.184770436731, 5118.3857937047605, 5122.769475373599, 4947.307376967192, 5006.949930500721, 5016.272640467112, 5023.949760502384, 5026.0, 5025.597952163818, 5028.698278103326, 5044.218146187347, 5049.166887463564, 5099.796008159669, 5007.073691367109, 5013.423456302536, 5031.949680503185, 5056.292119103328, 5061.822836200752, 5415.783368665248, 5418.051840927822, 5454.290942177531, 5499.807506737245, 5517.227588137664, 5861.5603829712945, 5875.412458754133, 5882.323532793741, 5889.617174883619, 5891.351951285355, 5787.681677507735, 5812.418758124196, 5927.7925272615685, 5929.762809487615, 5934.37689042653, 5421.539169170585, 5444.40111587725, 5446.836594902159, 5457.345118585756, 5524.8342549723175, 5973.044312909914, 5985.132155837379, 5985.700714964234, 6001.789937352171, 6015.669138197353, 5689.857753556194, 5771.59598828078, 5798.536117110621, 5815.5929084963645, 5844.795432159854, 5874.941250587525, 5875.529957603381, 5886.0, 5914.792982245601, 5922.615030023035, 5704.11586204139, 5821.912671309934, 5896.056630939029, 5905.527557795366, 5916.822495325147, 5718.79984200551, 5854.18041474194, 5899.174115623816, 5930.0, 5938.762449502058, 4500.662450316239, 4523.5024147343765, 4527.637788976874, 4562.954370456253, 4568.0, 3984.601539845992, 3992.341263691458, 4006.0, 4013.7591744495426, 4031.314676505001, 5562.415946325658, 5572.442755724476, 5626.774929002876, 5659.405762394971, 5683.801066962719, 5952.404759524013, 5973.970130149321, 5978.461938425563, 5978.581499295007, 5978.730957106941, 5605.607607467438, 5613.550915926716, 5615.129654903497, 5620.409856965041, 5624.072028115315, 4860.902781944412, 4924.8768780780765, 4970.204767237297, 4981.0, 4982.9252561211615, 6096.756129754849, 6156.261248650101, 6159.5072394208355, 6170.0, 6171.722272497748, 5813.534917206698, 6004.339522652417, 6004.519638429003, 6007.12896629995, 6018.969905150446, 6051.394860513913, 6057.242844644419, 6085.148079268817, 6122.032447070661, 6138.846528836815, 5832.445917637818, 5833.7666493341485, 5834.94165058344, 5839.941600583939, 5885.911711324419, 5836.649801011953, 5912.793052243151, 5934.258217722785, 5935.376785437467, 5978.850528736816, 5723.284589426322, 5736.397678243724, 5797.855053623524, 5816.534677225727, 5844.415558444121, 5751.33859606134, 5766.826995190151, 5817.912731308949, 5828.912566311594, 5832.620879642979, 5714.857128571819, 5721.685307307972, 5734.827955161351, 5762.962666720031, 5763.769449222152, 5686.374498805046, 5719.256496655408, 5824.650520968756, 5846.56150788684, 5891.764329426775, 5696.829095127153, 5711.485966263056, 5731.312242530923, 5731.598788084961, 5752.395998420273], "value": 5438.891409098349, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [560.5375565158743, 589.551940525201, 599.9730012149453, 614.0788816774837, 624.5503237668883, 38642.806785966066, 41990.99999999996, 42008.369874451906, 42046.7897660512, 42154.57845421545, 41037.58962410375, 41199.38200926981, 41345.7932710336, 41372.58627413725, 41515.16969660613, 8554.572271386422, 8677.088905664908, 8707.434016788888, 8792.560371981408, 8802.559872006406, 8566.785830354229, 8693.782655433633, 8701.43440676354, 8703.912960870373, 8711.825763484727, 8664.913350866475, 8698.608562614698, 8746.212840844322, 8757.211850933414, 8777.2100510954, 8607.61265743043, 8649.913500865005, 8657.307415406784, 8683.088275731021, 8718.389712720113, 8640.049594544658, 8652.091530389282, 8702.0, 8724.38929274951, 8731.912680873173, 38871.61128388708, 38973.61026389728, 39292.0, 39348.60651393478, 39522.80238598817, 3484.4947482615135, 3522.7886326820217, 3574.857005719768, 3765.8493660253557, 4168.7290326128705, 32527.6747232527, 32561.837190813894, 32951.6704832951, 33089.33821323584, 33965.32069358624, 4283.678724095674, 4368.563143685637, 4369.4319738434115, 4514.683972121953, 4553.453585569753, 355545.0, 355837.0, 355990.0, 356021.0, 356114.0, 34013.0, 58735.0, 58768.11847822286, 58848.41151588515, 58994.410055898894, 34187.316253674784, 36314.45528317078, 36573.63426365756, 36674.63325366766, 36754.81622591923, 15270.31283592241, 15286.159261240517, 15375.308111135026, 15438.9228053859, 15450.0, 13153.671158221121, 13165.868341316464, 13189.208647481182, 13222.867771322357, 13248.602541923758, 8195.0, 8220.876686849702, 8242.876356854653, 8298.460600060977, 8345.457545259538, 3241.594800649919, 3256.299895522474, 3262.1844538865284, 3273.214428537134, 3277.443214473154, 978.3542861711236, 1021.2851004297022, 1033.3541536539663, 1063.3726101600093, 1088.2654208409451, 30760.0, 32441.0, 32462.513062304086, 32566.511502327485, 32928.67071329304, 1123.2867129372744, 1146.5643055638805, 1177.1112809828526, 1182.9645110646695, 1226.3071364678929, 16133.596660083356, 16355.509334719978, 16547.338106475847, 16757.91621041887, 16810.411635592696, 535631.0, 539663.0, 545439.0, 545700.0, 546811.0, 58138.0, 58356.0, 58719.0, 59030.11454828181, 59181.112283315786, 1358.7078778062764, 1377.5660666889898, 1386.7919812028276, 1401.7804510076298, 1408.8379836318954, 30427.0, 31271.687283126877, 31313.530297046018, 31411.528827067155, 32094.0, 49519.0, 50364.74817625889, 50429.74785126198, 50762.0, 50771.0, 463634.0, 469603.0, 472095.0, 472674.0, 472872.0, 27324.590131148445, 27748.583771243044, 27925.44149117047, 27930.58104128399, 27947.720522794512, 47002.29496557486, 47972.52027479681, 48068.0, 48951.75524122357, 49084.0, 40803.59196408117, 41540.71281529896, 41685.374719378626, 42648.36027459529, 42916.570834291255, 41231.381529276485, 41948.79025604852, 42129.76981766995, 42159.0, 43044.56955430531, 39231.80384098061, 40677.389839151845, 41493.79253103715, 41532.58467415287, 41574.1685166301, 34854.477182842784, 36252.81873590615, 36771.44842827413, 37063.81468092642, 37328.25343493061, 28230.43539129247, 28304.15087547377, 28544.85727571349, 28595.42809143764, 28739.13782586526], "value": 18882.088841925837, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [398.631266078877, 398.76871414579546, 403.35463258785944, 406.0964354311656, 416.88535652695526, 18368.0, 19952.60094798103, 20030.49923751907, 20245.190192392285, 20251.0, 19165.904170479127, 19567.706484402745, 19690.409287721355, 19714.112864921077, 19771.406857794253, 5432.375276843174, 5641.407652196522, 5673.404292549264, 5728.140778883159, 5797.65214087154, 5659.5755318351285, 5716.857078573027, 5738.368779434259, 5762.6254293471, 5764.769409223626, 5731.484166425021, 5747.540196784268, 5851.912221316684, 5935.10973353996, 5981.222441082653, 5854.502367298764, 5955.731992060346, 5989.55078369124, 5991.221141251653, 5997.250343707036, 5585.469380408855, 5637.8590535236535, 5767.480926716616, 5780.971095144498, 5843.941560584425, 14392.424303027867, 14417.207053612046, 19965.800341996684, 23637.527249455088, 24018.0, 2342.417805965243, 2355.4817940053163, 2438.0979037755965, 2949.587057811908, 2981.4633365994114, 10265.794684106277, 10431.21765867563, 10472.954539818022, 10757.946210268978, 14786.63033424173, 1963.234338607944, 2013.2651582172548, 2025.1899240303849, 2036.9185232590678, 2057.9794202058088, 85919.14080859174, 86462.70305945478, 87503.12496875077, 88590.11409885947, 89960.0, 10736.838947415796, 10801.0, 10998.450077496092, 11245.606403775992, 11289.209755317213, 15378.231088445533, 15392.923035384976, 15438.228088595526, 15461.5311545403, 15497.225138743017, 8149.0, 8374.41379103469, 8413.074561798197, 8527.360447966428, 8551.273141782895, 7898.684052637945, 7967.0, 8071.798205044921, 8091.838163236703, 8116.6347514362, 4713.316569097462, 4750.311204875274, 4764.475907650156, 4791.257355109963, 4820.68665536739, 1974.664307067802, 1981.3857704111483, 2028.6247044296852, 2033.1968872295656, 2047.4164863013968, 946.3470205558281, 977.7360112769512, 1026.10728666061, 1031.1956673794452, 1044.5090807320548, 19535.120919558653, 19806.70289945652, 19874.403767886986, 19974.400767976986, 20066.297679581145, 1002.5839276700234, 1013.4122209118841, 1049.9317544359592, 1055.2454994678842, 1058.0371861605902, 10499.370037797757, 10951.4524273786, 10962.177836662282, 10973.286736362112, 11032.28290161137, 482557.0, 486406.0, 491302.0, 491827.0, 492616.0, 92608.0, 94359.05640943503, 94946.0505394951, 95005.0, 96924.51537742266, 998.8052329795765, 1003.3377970539409, 1012.9240306976859, 1013.7313611892854, 1023.5905637744961, 17240.310387584355, 17475.56311092233, 17624.1187940605, 17861.374851880642, 18199.909000454914, 41888.3716744243, 42230.577694222666, 42309.788451057546, 43341.0, 43805.91673625103, 59735.40264597299, 59822.70088649529, 60458.0, 60911.0, 61288.387116128266, 8687.91312086871, 8767.21095101444, 8818.382713210014, 8935.687250946186, 9024.729258122266, 9930.702078937644, 13495.730085398041, 13732.313384330942, 13804.654883627989, 13839.446422143405, 11606.12954028468, 11999.940000299943, 12002.75994480123, 12046.75906481848, 12125.575604853788, 11870.0, 11911.043725031726, 12015.19772034202, 12063.336516491327, 12077.214981026205, 11970.700732481757, 12058.698532536406, 12282.795731010041, 12292.262464252173, 12393.132480726263, 8771.684247362946, 8786.648534058822, 8837.955810221165, 8937.28501719848, 8967.372283940062, 9160.31297652692, 11724.120690948042, 11865.169438139592, 11903.047756179312, 12428.254304741744], "value": 9406.713588667879, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1483.1016299137102, 1501.4219525482688, 1657.1548510259763, 1765.8675599330054, 1786.5801536638887, 7676.462647614655, 8391.496510209376, 8397.748067557975, 9011.729648110559, 9014.188723014928, 8442.788930276745, 8682.044975052739, 8684.131586841313, 8735.257503112243, 8761.299096072315, 2286.8170546356337, 2309.9769002310013, 2316.814654827618, 2318.0959425823944, 2328.1734984080576, 2277.5900337939247, 2285.02886273334, 2302.182725132579, 2320.6519022146645, 2333.0317918063984, 2241.977580224201, 2252.1104163855266, 2255.8195344372493, 2323.256557901472, 2324.2562380038394, 2280.5324908393904, 2286.451251699597, 2310.295359915225, 2311.4683622766775, 2315.5600435917204, 2242.6299660555987, 2258.119333459952, 2258.3563684349883, 2259.7175353080866, 2261.5363850410627, 8854.645814167425, 8892.911070889339, 8902.510361930155, 8917.286617070618, 8931.955340223321, 5044.0, 5238.79044838206, 5263.763130659129, 5298.576113910878, 5302.045631786277, 3288.2272665923488, 3411.9488207676904, 3466.618671946084, 3484.5992710838073, 3484.9128771780656, 1149.293184691417, 1159.3739380734394, 1953.8143876331726, 2037.4397040813747, 2103.5056761661, 12038.217515861528, 12105.213161144497, 12140.15018948674, 12187.146899717023, 12225.572104976283, 4405.471343438808, 4451.9554804451545, 4560.065186636732, 4574.428196475441, 4580.358749774968, 9571.521423928776, 9579.473128977974, 9601.37591056593, 9605.759856003655, 9618.0, 5144.0, 5147.3051138096625, 5159.097157997336, 5171.01750667372, 5187.662801917863, 4387.276099443556, 4564.863054108382, 4718.433787945469, 4726.976365118221, 4824.734639594856, 3699.408094704834, 3725.3108174987715, 3739.121306492972, 3800.3729384651224, 3812.694984401241, 1155.9711007224719, 1217.3304682424632, 1223.2843088343861, 1224.406163010939, 1227.8035514317667, 894.5482531321771, 995.721198064543, 1003.2626019875386, 1009.333839665817, 1027.3322340478749, 5841.591088623755, 5865.560082993792, 5880.470757631748, 6052.485538729257, 6056.273247210275, 948.8102379523984, 949.3164921256684, 965.1410244882061, 975.22956864078, 993.4883534979491, 4032.959670403317, 4270.978645106817, 4388.912221755547, 4412.36020776992, 4463.620592249695, 10581.153507719364, 11080.335179889233, 11131.666050018512, 11197.552097916156, 11232.213745037769, 10490.947545262377, 10920.399378034126, 10959.780804384027, 11043.0, 11304.49129789145, 8171.0, 8177.877331840146, 8231.0, 8274.875876861852, 8306.54314012723, 6013.248343957005, 6187.195664563578, 6195.938040619536, 6253.218347706536, 6280.811575652738, 10103.848442273225, 10126.13927816144, 10196.592136314464, 10285.331453455501, 10299.691009269734, 9989.0, 10370.377777333384, 10433.269671123253, 10453.9477302613, 10491.160707143563, 7019.08751862275, 7614.581198034161, 7851.764447066597, 7956.283934445928, 8062.113167551682, 8693.652253909773, 8743.256823170103, 8772.38593298463, 8775.517346546001, 8787.25308348772, 7686.077670679554, 7698.769036928901, 7737.14891361961, 7759.952406425286, 8068.838623227385, 7328.5969271690565, 7721.073471183494, 7868.763937081897, 7997.800054998672, 8027.036755589366, 6709.396154346132, 6970.756023539152, 6979.546329488567, 6982.7206911725, 6986.021956926136, 4548.704334218265, 4634.655532358975, 4750.14497390473, 4752.477227504903, 4815.711057336571, 5169.302144210634, 5256.947430525645, 5354.063038968243, 5397.406285308534, 5419.376771671308], "value": 4677.027225868707, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [315.6307120668817, 322.04192527231487, 324.98442367601245, 325.71499937554637, 326.4483023689962, 5603.215549823023, 5631.267935168427, 5640.51817200432, 5657.349404818437, 5657.688827114507, 5560.888782224353, 5568.387477377495, 5571.331440227178, 5592.552595792337, 5611.270534830476, 4084.3260861957815, 4175.519815221258, 4266.530681625019, 4291.6566674665955, 4307.440032795732, 4257.276263035292, 4262.381954616579, 4262.403263543107, 4262.72292301001, 4266.850660226893, 4222.429971953778, 4237.766922819259, 4241.4274073000215, 4243.151369726052, 4243.642034548946, 4035.535913369956, 4230.153969206141, 4247.0039081631585, 4247.214265360887, 4290.935635965463, 3674.6325367463305, 3679.245754620323, 3682.8895133146048, 3701.648343407372, 3714.4799728038097, 5450.29146210994, 5458.0721277382545, 5470.398256191816, 5492.890142197134, 5528.834134975958, 4707.411573553306, 4888.242322440027, 4935.136351138536, 4958.281049247839, 4972.552470277692, 5808.738606762706, 5848.327442344143, 5854.297484301868, 5857.414258574151, 5883.558733095035, 4049.2104039712267, 4058.918821623551, 4125.443065186191, 4126.101993083185, 4134.751914885116, 5930.288365396137, 6070.605410648293, 6084.117802918597, 6101.0, 6127.969360153171, 4135.015192707518, 4180.435641188462, 4182.163567286494, 4198.412222288882, 4211.536730959592, 4230.238557059697, 4239.9788001060415, 4246.4691913510815, 4251.766152861561, 4258.68059895509, 4623.352730617717, 4886.755662216875, 4903.215485522299, 4925.975370123198, 4933.802647894044, 5853.414658534198, 5858.0, 5874.853128671817, 5908.704564771744, 5972.46247837688, 1459.3214155417782, 1466.911985280865, 1480.4374337751801, 1481.3852251315584, 1481.5259117082646, 923.6259314977444, 932.7201839448138, 940.8259471997702, 946.8437707778277, 947.1712251779693, 5500.58745594082, 5550.7779688812, 5581.302337207849, 5604.355499117572, 5618.185363122406, 5948.762049517971, 5953.791617293374, 5954.85112872173, 5999.730012149464, 6062.939370606326, 5450.209719590716, 5691.516221121251, 5733.569982251264, 5747.074729965425, 5757.251557297608, 3219.2455111964036, 3224.4357237483346, 3235.7411407087375, 3245.918852028718, 3248.6101667799544, 6087.817365479043, 6225.221847269091, 6242.250929888442, 6280.371962803683, 6332.810015699536, 6101.481374083252, 6151.384861513902, 6155.599886007395, 6165.630062196283, 6179.84550386244, 6128.233970753656, 6224.688765561704, 6230.408111229426, 6262.749490020348, 6267.655278959701, 6047.881141988746, 6056.0, 6064.939350606437, 6084.148219249397, 6085.330613632408, 5950.553708471795, 5960.314563825215, 6002.489788367863, 6022.397760223943, 6025.764718232839, 6050.576459647782, 6188.907166392598, 6217.96891015542, 6229.56393052482, 6249.78125765596, 4073.920411091004, 4086.468759061303, 4094.897627559335, 4127.504699436087, 4130.834766609302, 5777.62445441045, 5788.334341550775, 6023.247094113236, 6037.69811509414, 6063.272407311151, 5763.164341170591, 5782.5373970081455, 5793.536517078539, 5800.1299805029585, 5801.6519008859605, 5816.47651711348, 5830.416958304136, 5842.970785146217, 5847.0, 5886.352501224947, 5538.944610553843, 5744.712764361849, 5760.567957403296, 5784.797532086357, 5793.391693872083, 5808.796692115756, 5863.2670916135485, 5869.0, 5878.765459253434, 5880.823835233056, 5432.701201433959, 5698.914516282342, 5701.657900525982, 5715.257016587817, 5770.6249093808765], "value": 4418.847802943463, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [623.5541587764748, 625.2934184371659, 733.2117973178831, 747.1557140431312, 786.9567173805442, 15010.249487525622, 16221.513354599367, 16307.184640767973, 16313.51059468215, 16373.345066197367, 14095.083819551723, 14168.787468187986, 14197.71604567908, 14213.289335533234, 14311.57065288043, 792.0495405513378, 794.6463823598501, 811.123986095016, 811.2212276214841, 811.7686459359084, 785.9724909628164, 822.0874828939872, 826.1366871619173, 826.904905935816, 827.7682248970298, 863.8013256950906, 866.8959724833029, 867.5792240763257, 869.0744357259498, 872.4634349874844, 853.7566793463864, 855.7689423855586, 856.297835774665, 856.8543347630949, 859.0679113162164, 630.706721374563, 631.516889579472, 631.7915088020942, 632.0897907013886, 632.822809613309, 14330.785038224434, 14345.928270358581, 14359.856401435956, 14459.27703614815, 14521.419143234258, 14328.64178395538, 14340.64148396288, 14546.199959002251, 14703.852961470462, 14724.926375368163, 12454.903206276576, 12563.18339307942, 12606.0, 12919.806202906964, 13193.20840749558, 3934.252492026506, 3947.684185265172, 4068.8982775430554, 4159.563245859172, 4172.728772629769, 77765.0, 78791.60604196943, 79200.60399698022, 79838.60080699559, 80414.59792701057, 11306.0, 11427.48576314068, 11505.367204803648, 11597.246178998337, 11645.73397587948, 21406.892965535073, 21432.78567214308, 21436.0, 21442.0, 21479.892600536896, 8633.568321584022, 8888.777780555538, 8922.509261990654, 9068.954655226682, 9210.861837072449, 5050.535344749981, 5079.873003174876, 5179.922301165486, 5237.6071794615555, 5400.567954563626, 3626.2747450510005, 3689.4281386385155, 3697.759645623026, 3740.8129593520216, 3749.456328832304, 612.2408213814838, 625.5589809184605, 635.9459445947147, 640.8365866704054, 656.9770058048041, 675.8006388115517, 689.3451221339648, 696.9581825090511, 697.1459961547064, 717.7667258141125, 9773.267004974514, 10235.846462303072, 10349.172066234683, 10395.32430392022, 10450.372977621368, 681.6455443169623, 767.6775754183257, 771.8301973565807, 780.9453338266267, 790.7509134622576, 4599.356090147382, 4821.156297647897, 4847.781849816767, 4861.829835955796, 4882.902341953141, 110530.44734776275, 118865.40567297109, 121591.39204303922, 121803.0, 122979.0, 103006.0, 105782.47108764407, 106440.46779766052, 106841.46579267054, 107031.0, 79427.0, 87716.0, 88408.5579572098, 90546.0, 93158.53420732853, 8999.955000224956, 9006.86489702668, 9157.0, 9162.67930622425, 9264.95367523185, 44581.0, 51103.0, 51373.50454180722, 52036.73981630067, 52366.738166308925, 67534.66232668805, 68744.65627671829, 68960.0774787456, 74200.25799741934, 79681.0, 13650.658733531742, 13884.119314778565, 14389.568312950629, 14555.636109097357, 14674.266286685837, 15653.452129175424, 15693.921530392276, 15950.60123496922, 16054.277557509706, 16499.67000660004, 14256.358463869357, 14725.410983560538, 14768.0, 14799.704005919606, 15454.459093931659, 13814.102083364549, 13914.86085139176, 14130.293485325898, 14291.356888939814, 14831.92584037073, 12452.875471245534, 13795.79306310386, 13812.723745525234, 13983.510577130159, 14047.578572642837, 11904.166708330335, 11909.40452977365, 12199.0, 12253.938730306292, 12441.191322564004, 10657.89342106569, 10967.561297548009, 11464.0, 12223.69440763988, 12418.503259869503], "value": 7741.009429308492, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1529.6000000000001, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [102.0, 111.0, 108.0, 111.0, 115.0, 112.0, 111.0, 112.0, 113.0, 110.0], "value": 110.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 117.0, 149.0, 173.0, 119.0, 148.0, 147.0, 126.0, 184.0, 117.0], "value": 143.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 163.0, 163.0, 162.0, 163.0, 163.0, 167.0, 167.0, 162.0, 165.0], "value": 163.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 74.0, 75.0, 158.0, 79.0, 79.0, 74.0, 75.0, 183.0, 76.0], "value": 94.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 84.0, 166.0, 85.0, 84.0, 84.0, 144.0, 84.0, 85.0, 158.0], "value": 106.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 118.0, 117.0, 118.0, 118.0, 118.0, 117.0, 117.0, 118.0], "value": 117.6, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 147.0, 146.0, 147.0, 147.0, 147.0, 147.0, 147.0, 147.0, 147.0], "value": 146.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 95.0, 95.0, 95.0, 96.0, 96.0, 96.0, 95.0, 95.0], "value": 95.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 55.0, 54.0, 54.0, 55.0, 53.0, 55.0, 58.0, 56.0, 58.0], "value": 55.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 64.0, 62.0, 63.0, 63.0, 63.0, 62.0, 63.0, 62.0, 63.0], "value": 62.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 82.0, 77.0, 81.0, 77.0, 76.0, 76.0, 81.0, 81.0, 76.0], "value": 78.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [134.0, 133.0, 133.0, 134.0, 128.0, 130.0, 126.0, 126.0, 162.0, 123.0], "value": 132.9, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [158.0, 156.0, 159.0, 157.0, 155.0, 157.0, 160.0, 163.0, 160.0, 162.0], "value": 158.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 63.0, 64.0, 65.0, 64.0, 62.0, 63.0, 63.0, 64.0, 64.0], "value": 63.6, "unit": "score"}]}]} 12:48:01 INFO - Return code: 0 12:48:01 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 12:48:01 ERROR - # TBPL SUCCESS # 12:48:01 INFO - Running post-action listener: _resource_record_post_action 12:48:01 INFO - ##### 12:48:01 INFO - ##### Finished run-tests step (success) 12:48:01 INFO - ##### 12:48:01 INFO - Running post-run listener: _resource_record_post_run 12:48:01 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 4096; Write bytes: 572649472; Read time: 12; Write time: 620104 12:48:01 INFO - TinderboxPrint: CPU usage
13.3% 12:48:01 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 12:48:01 INFO - TinderboxPrint: I/O write bytes / time
572,649,472 / 620,104 12:48:01 INFO - TinderboxPrint: CPU idle
8,243.5 (86.7%) 12:48:01 INFO - TinderboxPrint: CPU user
1,211.6 (12.7%) 12:48:01 INFO - TinderboxPrint: Swap in / out
0 / 0 12:48:01 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 278077440; Read time: 0; Write time: 369672 12:48:01 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 0; Write bytes: 294383616; Read time: 0; Write time: 250404 12:48:02 INFO - Running post-run listener: _upload_blobber_files 12:48:02 INFO - Blob upload gear active. 12:48:02 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 12:48:02 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 12:48:02 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'] 12:48:02 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 12:48:02 INFO - (blobuploader) - INFO - Open directory for files ... 12:48:02 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 12:48:02 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:48:02 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:48:03 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 12:48:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:48:03 INFO - (blobuploader) - INFO - Done attempting. 12:48:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 12:48:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:48:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:48:08 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 12:48:08 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:48:08 INFO - (blobuploader) - INFO - Done attempting. 12:48:08 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 12:48:08 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:48:08 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:48:09 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 12:48:09 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:48:09 INFO - (blobuploader) - INFO - Done attempting. 12:48:09 INFO - (blobuploader) - INFO - Iteration through files over. 12:48:09 INFO - Return code: 0 12:48:09 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 12:48:09 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 12:48:09 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b222b68ba710653344fd7f47a072f1a45c9fadd0014b1185b288275dbda91e81eb05bc2caee9fa2b0d7a3af545e0dfae598997bfe43f3a01a9b0c69ea8b482d2", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/c976b5622a1c3bd63eea912bf34ea7e5916a39e3afabd3bc63f8b2eab065598bdc4a98aaa9b9a277f46ea29e661587512c1214df4d3d817e9400ea94802b0e89", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/fdc9bcb5d697f6546983c86b98a319fbf7c860cf5ab5f31b62df6e9f08d9c828fc989e39c2e748589b6e4eca858f1af060cfb31f3eed769d3c2208daf97af956"} 12:48:09 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 12:48:09 INFO - Writing to file /builds/slave/test/properties/blobber_files 12:48:09 INFO - Contents: 12:48:09 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b222b68ba710653344fd7f47a072f1a45c9fadd0014b1185b288275dbda91e81eb05bc2caee9fa2b0d7a3af545e0dfae598997bfe43f3a01a9b0c69ea8b482d2", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/c976b5622a1c3bd63eea912bf34ea7e5916a39e3afabd3bc63f8b2eab065598bdc4a98aaa9b9a277f46ea29e661587512c1214df4d3d817e9400ea94802b0e89", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/fdc9bcb5d697f6546983c86b98a319fbf7c860cf5ab5f31b62df6e9f08d9c828fc989e39c2e748589b6e4eca858f1af060cfb31f3eed769d3c2208daf97af956"} 12:48:09 INFO - Running post-run listener: copy_logs_to_upload_dir 12:48:09 INFO - Copying logs to upload dir... 12:48:09 INFO - mkdir: /builds/slave/test/build/upload/logs 12:48:09 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1232.172544 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 32 secs) (at 2016-07-15 12:48:08.865275) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-15 12:48:08.868824) ========= 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=d2a8c569965ab8367867b893000001a1-1468610853.781037-210783091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b222b68ba710653344fd7f47a072f1a45c9fadd0014b1185b288275dbda91e81eb05bc2caee9fa2b0d7a3af545e0dfae598997bfe43f3a01a9b0c69ea8b482d2", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/c976b5622a1c3bd63eea912bf34ea7e5916a39e3afabd3bc63f8b2eab065598bdc4a98aaa9b9a277f46ea29e661587512c1214df4d3d817e9400ea94802b0e89", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/fdc9bcb5d697f6546983c86b98a319fbf7c860cf5ab5f31b62df6e9f08d9c828fc989e39c2e748589b6e4eca858f1af060cfb31f3eed769d3c2208daf97af956"} build_url:https://queue.taskcluster.net/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011298 build_url: 'https://queue.taskcluster.net/v1/task/b6ou9dPDQpalcDoAEKkR8A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b222b68ba710653344fd7f47a072f1a45c9fadd0014b1185b288275dbda91e81eb05bc2caee9fa2b0d7a3af545e0dfae598997bfe43f3a01a9b0c69ea8b482d2", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/c976b5622a1c3bd63eea912bf34ea7e5916a39e3afabd3bc63f8b2eab065598bdc4a98aaa9b9a277f46ea29e661587512c1214df4d3d817e9400ea94802b0e89", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/fdc9bcb5d697f6546983c86b98a319fbf7c860cf5ab5f31b62df6e9f08d9c828fc989e39c2e748589b6e4eca858f1af060cfb31f3eed769d3c2208daf97af956"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-15 12:48:08.895292) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:48:08.895605) ========= 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=d2a8c569965ab8367867b893000001a1-1468610853.781037-210783091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004391 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:48:08.979032) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-15 12:48:08.979349) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-15 12:48:08.979639) ========= ========= Total master_lag: 0.17 =========