builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-049 starttime: 1467381781.58 results: success (0) buildid: 20160701062022 builduid: 4714f42bdbb0417a8605da1deb05564d revision: 1aca6ed481adc49038a6af063c79eaf494fd6125 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:01.583680) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:01.584182) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:01.584490) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:01.618351) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:01.618667) ========= 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=db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-01 07:03:02-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 208M=0s 2016-07-01 07:03:02 (208 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.102992 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:01.754232) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:01.754579) ========= 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=db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022512 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:01.838410) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:01.839125) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 1aca6ed481adc49038a6af063c79eaf494fd6125 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 1aca6ed481adc49038a6af063c79eaf494fd6125 --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=db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-01 07:03:02,822 truncating revision to first 12 chars 2016-07-01 07:03:02,822 Setting DEBUG logging. 2016-07-01 07:03:02,822 attempt 1/10 2016-07-01 07:03:02,823 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/1aca6ed481ad?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-01 07:03:03,133 unpacking tar archive at: fx-team-1aca6ed481ad/testing/mozharness/ program finished with exit code 0 elapsedTime=0.629245 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:02.483949) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:02.484325) ========= script_repo_revision: 1aca6ed481adc49038a6af063c79eaf494fd6125 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:02.484803) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:02.485103) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-01 07:03:02.496658) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-07-01 07:03:02.497269) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 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', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] 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=db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07:03:03 INFO - MultiFileLogger online at 20160701 07:03:03 in /builds/slave/test 07:03:03 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 07:03:03 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 07:03:03 INFO - {'append_to_log': False, 07:03:03 INFO - 'base_work_dir': '/builds/slave/test', 07:03:03 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 07:03:03 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 07:03:03 INFO - 'branch': 'Fx-Team-Non-PGO', 07:03:03 INFO - 'buildbot_json_path': 'buildprops.json', 07:03:03 INFO - 'config_files': ('talos/linux_config.py',), 07:03:03 INFO - 'default_actions': ('clobber', 07:03:03 INFO - 'read-buildbot-config', 07:03:03 INFO - 'download-and-extract', 07:03:03 INFO - 'populate-webroot', 07:03:03 INFO - 'create-virtualenv', 07:03:03 INFO - 'install', 07:03:03 INFO - 'run-tests'), 07:03:03 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:03:03 INFO - 'download_minidump_stackwalk': True, 07:03:03 INFO - 'download_symbols': 'ondemand', 07:03:03 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:03:03 INFO - 'tooltool.py': '/tools/tooltool.py', 07:03:03 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:03:03 INFO - '/tools/misc-python/virtualenv.py')}, 07:03:03 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:03:03 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:03:03 INFO - 'installer_path': 'installer.exe', 07:03:03 INFO - 'log_level': 'info', 07:03:03 INFO - 'log_name': 'talos', 07:03:03 INFO - 'log_to_console': True, 07:03:03 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 07:03:03 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 07:03:03 INFO - 'opt_config_files': (), 07:03:03 INFO - 'pip_index': False, 07:03:03 INFO - 'sps_profile': False, 07:03:03 INFO - 'sps_profile_interval': 0, 07:03:03 INFO - 'suite': 'dromaeojs-e10s', 07:03:03 INFO - 'system_bits': '32', 07:03:03 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:03:03 INFO - 'title': 'talos-linux64-ix-049', 07:03:03 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:03:03 INFO - 'use_talos_json': True, 07:03:03 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 07:03:03 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:03:03 INFO - 'work_dir': 'build'} 07:03:03 INFO - ##### 07:03:03 INFO - ##### Running clobber step. 07:03:03 INFO - ##### 07:03:03 INFO - Running pre-action listener: _resource_record_pre_action 07:03:03 INFO - Running main action method: clobber 07:03:03 INFO - rmtree: /builds/slave/test/build 07:03:03 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 07:03:04 INFO - Running post-action listener: _resource_record_post_action 07:03:04 INFO - ##### 07:03:04 INFO - ##### Finished clobber step (success) 07:03:04 INFO - ##### 07:03:04 INFO - ##### 07:03:04 INFO - ##### Running read-buildbot-config step. 07:03:04 INFO - ##### 07:03:04 INFO - Running pre-action listener: _resource_record_pre_action 07:03:04 INFO - Running main action method: read_buildbot_config 07:03:04 INFO - Using buildbot properties: 07:03:04 INFO - { 07:03:04 INFO - "project": "", 07:03:04 INFO - "product": "firefox", 07:03:04 INFO - "script_repo_revision": "production", 07:03:04 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 07:03:04 INFO - "repository": "", 07:03:04 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 07:03:04 INFO - "buildid": "20160701062022", 07:03:04 INFO - "pgo_build": "False", 07:03:04 INFO - "basedir": "/builds/slave/test", 07:03:04 INFO - "buildnumber": 1401, 07:03:04 INFO - "slavename": "talos-linux64-ix-049", 07:03:04 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 07:03:04 INFO - "platform": "ubuntu64_hw", 07:03:04 INFO - "scheduler": "tests-fx-team-linux64-talos", 07:03:04 INFO - "branch": "fx-team", 07:03:04 INFO - "repo_path": "integration/fx-team", 07:03:04 INFO - "revision": "1aca6ed481adc49038a6af063c79eaf494fd6125", 07:03:04 INFO - "stage_platform": "linux64", 07:03:04 INFO - "builduid": "4714f42bdbb0417a8605da1deb05564d", 07:03:04 INFO - "slavebuilddir": "test" 07:03:04 INFO - } 07:03:04 INFO - Found installer url https://queue.taskcluster.net/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 07:03:04 INFO - Running post-action listener: _resource_record_post_action 07:03:04 INFO - ##### 07:03:04 INFO - ##### Finished read-buildbot-config step (success) 07:03:04 INFO - ##### 07:03:04 INFO - ##### 07:03:04 INFO - ##### Running download-and-extract step. 07:03:04 INFO - ##### 07:03:04 INFO - Running pre-action listener: _resource_record_pre_action 07:03:04 INFO - Running main action method: download_and_extract 07:03:04 INFO - mkdir: /builds/slave/test/build/tests 07:03: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')]} 07:03:04 INFO - https://queue.taskcluster.net/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 07:03:04 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 07:03:04 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 07:03:04 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/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 07:03:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/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 07:03:08 INFO - Downloaded 1361 bytes. 07:03:08 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 07:03:08 INFO - Using the following test package requirements: 07:03:08 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 07:03:08 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:03:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 07:03:08 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:03:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 07:03:08 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:03:08 INFO - u'jsshell-linux-x86_64.zip'], 07:03:08 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:03:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 07:03:08 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 07:03:08 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:03:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 07:03:08 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:03:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 07:03:08 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:03:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 07:03:08 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:03:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 07:03:08 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 07:03: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')]} 07:03:08 INFO - https://queue.taskcluster.net/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:03:08 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:03:08 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:03:08 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/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 07:03:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/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 07:03:11 INFO - Downloaded 22704123 bytes. 07:03:11 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'] 07:03:11 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 07:03:12 INFO - Return code: 0 07:03:12 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 07:03:12 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')]} 07:03:12 INFO - https://queue.taskcluster.net/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:03:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:03:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:03:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/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 07:03:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/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 07:03:14 INFO - Downloaded 22704123 bytes. 07:03:14 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'] 07:03:14 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 07:03:15 INFO - Return code: 0 07:03:15 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')]} 07:03:15 INFO - https://queue.taskcluster.net/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 07:03:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 07:03:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 07:03:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/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 07:03:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/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 07:03:16 INFO - Downloaded 14405242 bytes. 07:03:16 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'] 07:03:16 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 07:03:17 INFO - Return code: 0 07:03:17 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')]} 07:03:17 INFO - https://queue.taskcluster.net/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 07:03:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 07:03:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 07:03:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/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 07:03:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aEVpAFIgTfGFGfoGvrnC9A/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 07:03:18 INFO - Downloaded 56456518 bytes. 07:03:18 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 07:03:18 INFO - mkdir: /builds/slave/test/properties 07:03:18 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 07:03:18 INFO - Writing to file /builds/slave/test/properties/build_url 07:03:18 INFO - Contents: 07:03:18 INFO - build_url:https://queue.taskcluster.net/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 07:03:19 INFO - Running post-action listener: _resource_record_post_action 07:03:19 INFO - Running post-action listener: set_extra_try_arguments 07:03:19 INFO - ##### 07:03:19 INFO - ##### Finished download-and-extract step (success) 07:03:19 INFO - ##### 07:03:19 INFO - ##### 07:03:19 INFO - ##### Running populate-webroot step. 07:03:19 INFO - ##### 07:03:19 INFO - Running pre-action listener: _resource_record_pre_action 07:03:19 INFO - Running main action method: populate_webroot 07:03:19 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:03:19 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:03:19 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:03:19 INFO - '--tppagecycles', 07:03:19 INFO - '7'], 07:03:19 INFO - 'tests': ['tsvgm']}}, 07:03:19 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 07:03:19 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:03:19 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 07:03:19 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 07:03:19 INFO - 'tests': ['dromaeo_css', 'kraken']}, 07:03:19 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 07:03:19 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:03:19 INFO - 'talos_options': ['--disable-e10s'], 07:03:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:03:19 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:03:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:03:19 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:03:19 INFO - 'talos_options': ['--disable-e10s'], 07:03:19 INFO - 'tests': ['damp', 'tps']}, 07:03:19 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:03:19 INFO - 'tests': ['damp', 'tps']}, 07:03:19 INFO - 'g3': {'talos_options': ['--disable-e10s'], 07:03:19 INFO - 'tests': ['dromaeo_dom']}, 07:03:19 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:03:19 INFO - 'g4': {'talos_options': ['--disable-e10s'], 07:03:19 INFO - 'tests': ['basic_compositor_video']}, 07:03:19 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 07:03:19 INFO - 'other': {'talos_options': ['--disable-e10s'], 07:03:19 INFO - 'tests': ['a11yr', 07:03:19 INFO - 'ts_paint', 07:03:19 INFO - 'tpaint', 07:03:19 INFO - 'sessionrestore', 07:03:19 INFO - 'sessionrestore_no_auto_restore', 07:03:19 INFO - 'tabpaint']}, 07:03:19 INFO - 'other-e10s': {'tests': ['a11yr', 07:03:19 INFO - 'ts_paint', 07:03:19 INFO - 'tpaint', 07:03:19 INFO - 'sessionrestore', 07:03:19 INFO - 'sessionrestore_no_auto_restore', 07:03:19 INFO - 'tabpaint']}, 07:03:19 INFO - 'other-e10s_l64': {'tests': ['a11yr', 07:03:19 INFO - 'ts_paint', 07:03:19 INFO - 'tpaint', 07:03:19 INFO - 'sessionrestore', 07:03:19 INFO - 'sessionrestore_no_auto_restore', 07:03:19 INFO - 'tabpaint']}, 07:03:19 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 07:03:19 INFO - 'ts_paint', 07:03:19 INFO - 'tpaint', 07:03:19 INFO - 'sessionrestore', 07:03:19 INFO - 'sessionrestore_no_auto_restore', 07:03:19 INFO - 'tabpaint']}, 07:03:19 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 07:03:19 INFO - 'tests': ['a11yr', 07:03:19 INFO - 'ts_paint', 07:03:19 INFO - 'tpaint', 07:03:19 INFO - 'sessionrestore', 07:03:19 INFO - 'sessionrestore_no_auto_restore', 07:03:19 INFO - 'tabpaint']}, 07:03:19 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 07:03:19 INFO - 'tests': ['a11yr', 07:03:19 INFO - 'ts_paint', 07:03:19 INFO - 'tpaint', 07:03:19 INFO - 'sessionrestore', 07:03:19 INFO - 'sessionrestore_no_auto_restore', 07:03:19 INFO - 'tabpaint']}, 07:03:19 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 07:03:19 INFO - 'tests': ['tsvgx', 07:03:19 INFO - 'tsvgr_opacity', 07:03:19 INFO - 'tart', 07:03:19 INFO - 'tscrollx', 07:03:19 INFO - 'cart']}, 07:03:19 INFO - 'svgr-e10s': {'tests': ['tsvgx', 07:03:19 INFO - 'tsvgr_opacity', 07:03:19 INFO - 'tart', 07:03:19 INFO - 'tscrollx', 07:03:19 INFO - 'cart']}, 07:03:19 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:03:19 INFO - 'talos_options': ['--disable-e10s'], 07:03:19 INFO - 'tests': ['tp5o']}, 07:03:19 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:03:19 INFO - 'tests': ['tp5o']}, 07:03:19 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:03:19 INFO - 'talos_options': ['--disable-e10s', 07:03:19 INFO - '--xperf_path', 07:03:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:03:19 INFO - 'tests': ['tp5n']}, 07:03:19 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:03:19 INFO - 'talos_options': ['--xperf_path', 07:03:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:03:19 INFO - 'tests': ['tp5n']}}, 07:03:19 INFO - 'talos.zip': {'path': '', 07:03:19 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:03:19 INFO - Running post-action listener: _resource_record_post_action 07:03:19 INFO - ##### 07:03:19 INFO - ##### Finished populate-webroot step (success) 07:03:19 INFO - ##### 07:03:19 INFO - ##### 07:03:19 INFO - ##### Running create-virtualenv step. 07:03:19 INFO - ##### 07:03:19 INFO - Running pre-action listener: _resource_record_pre_action 07:03:19 INFO - Running main action method: create_virtualenv 07:03:19 INFO - Creating virtualenv /builds/slave/test/build/venv 07:03:19 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 07:03:19 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 07:03:19 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:03:19 INFO - Using real prefix '/usr' 07:03:19 INFO - New python executable in /builds/slave/test/build/venv/bin/python 07:03:19 INFO - Installing distribute.............................................................................................................................................................................................done. 07:03:21 INFO - Installing pip.................done. 07:03:21 INFO - Return code: 0 07:03:21 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 07:03:21 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')]} 07:03:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:03:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:21 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')]} 07:03:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:03:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:21 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 0x2609030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x276c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2838400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c7570>, '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 0x28c8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28c8900>, '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': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', '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 07:03:21 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 07:03:21 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 07:03:21 INFO - Using env: {'DISPLAY': ':0', 07:03:21 INFO - 'HOME': '/home/cltbld', 07:03:21 INFO - 'LANG': 'en_US.UTF-8', 07:03:21 INFO - 'LANGUAGE': 'en_US:en', 07:03:21 INFO - 'LOGNAME': 'cltbld', 07:03:21 INFO - 'MAIL': '/var/mail/cltbld', 07:03:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:03:21 INFO - 'MOZ_NO_REMOTE': '1', 07:03:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:03:21 INFO - 'NO_EM_RESTART': '1', 07:03:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:03:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:03:21 INFO - 'PWD': '/builds/slave/test', 07:03:21 INFO - 'SHELL': '/bin/bash', 07:03:21 INFO - 'SHLVL': '1', 07:03:21 INFO - 'TERM': 'linux', 07:03:21 INFO - 'TMOUT': '86400', 07:03:21 INFO - 'USER': 'cltbld', 07:03:21 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', 07:03:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:03:21 INFO - '_': '/tools/buildbot/bin/python'} 07:03:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:03:22 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 07:03:22 INFO - Cleaning up... 07:03:22 INFO - Return code: 0 07:03:22 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 07:03:22 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')]} 07:03:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:03:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:22 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')]} 07:03:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:03:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:22 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 0x2609030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x276c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2838400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c7570>, '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 0x28c8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28c8900>, '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': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', '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 07:03:22 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 07:03:22 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 07:03:22 INFO - Using env: {'DISPLAY': ':0', 07:03:22 INFO - 'HOME': '/home/cltbld', 07:03:22 INFO - 'LANG': 'en_US.UTF-8', 07:03:22 INFO - 'LANGUAGE': 'en_US:en', 07:03:22 INFO - 'LOGNAME': 'cltbld', 07:03:22 INFO - 'MAIL': '/var/mail/cltbld', 07:03:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:03:22 INFO - 'MOZ_NO_REMOTE': '1', 07:03:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:03:22 INFO - 'NO_EM_RESTART': '1', 07:03:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:03:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:03:22 INFO - 'PWD': '/builds/slave/test', 07:03:22 INFO - 'SHELL': '/bin/bash', 07:03:22 INFO - 'SHLVL': '1', 07:03:22 INFO - 'TERM': 'linux', 07:03:22 INFO - 'TMOUT': '86400', 07:03:22 INFO - 'USER': 'cltbld', 07:03:22 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', 07:03:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:03:22 INFO - '_': '/tools/buildbot/bin/python'} 07:03:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:03:22 INFO - Downloading/unpacking psutil>=3.1.1 07:03:22 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 07:03:22 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 07:03:22 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 07:03:22 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 07:03:22 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 07:03:22 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 07:03:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 07:03:24 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:03:24 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:03:24 INFO - Installing collected packages: psutil 07:03:24 INFO - Running setup.py install for psutil 07:03:24 INFO - building 'psutil._psutil_linux' extension 07:03:24 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 07:03:24 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 07:03:24 INFO - building 'psutil._psutil_posix' extension 07:03:24 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 07:03:24 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 07:03:24 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:03:24 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:03:24 INFO - Successfully installed psutil 07:03:24 INFO - Cleaning up... 07:03:24 INFO - Return code: 0 07:03:24 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 07:03:24 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')]} 07:03:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:03:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:24 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')]} 07:03:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:03:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:24 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 0x2609030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x276c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2838400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c7570>, '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 0x28c8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28c8900>, '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': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', '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 07:03:24 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 07:03:24 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 07:03:24 INFO - Using env: {'DISPLAY': ':0', 07:03:24 INFO - 'HOME': '/home/cltbld', 07:03:24 INFO - 'LANG': 'en_US.UTF-8', 07:03:24 INFO - 'LANGUAGE': 'en_US:en', 07:03:24 INFO - 'LOGNAME': 'cltbld', 07:03:24 INFO - 'MAIL': '/var/mail/cltbld', 07:03:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:03:24 INFO - 'MOZ_NO_REMOTE': '1', 07:03:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:03:24 INFO - 'NO_EM_RESTART': '1', 07:03:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:03:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:03:24 INFO - 'PWD': '/builds/slave/test', 07:03:24 INFO - 'SHELL': '/bin/bash', 07:03:24 INFO - 'SHLVL': '1', 07:03:24 INFO - 'TERM': 'linux', 07:03:24 INFO - 'TMOUT': '86400', 07:03:24 INFO - 'USER': 'cltbld', 07:03:24 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', 07:03:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:03:24 INFO - '_': '/tools/buildbot/bin/python'} 07:03:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:03:25 INFO - Downloading/unpacking mozsystemmonitor==0.3 07:03:25 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 07:03:25 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 07:03:25 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 07:03:25 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 07:03:25 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 07:03:25 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 07:03:26 INFO - Downloading mozsystemmonitor-0.3.tar.gz 07:03:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:03:27 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 07:03:27 INFO - Installing collected packages: mozsystemmonitor 07:03:27 INFO - Running setup.py install for mozsystemmonitor 07:03:27 INFO - Successfully installed mozsystemmonitor 07:03:27 INFO - Cleaning up... 07:03:27 INFO - Return code: 0 07:03:27 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 07:03:27 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')]} 07:03:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:03:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:27 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')]} 07:03:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:03:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:27 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 0x2609030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x276c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2838400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c7570>, '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 0x28c8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28c8900>, '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': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', '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 07:03:27 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 07:03:27 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 07:03:27 INFO - Using env: {'DISPLAY': ':0', 07:03:27 INFO - 'HOME': '/home/cltbld', 07:03:27 INFO - 'LANG': 'en_US.UTF-8', 07:03:27 INFO - 'LANGUAGE': 'en_US:en', 07:03:27 INFO - 'LOGNAME': 'cltbld', 07:03:27 INFO - 'MAIL': '/var/mail/cltbld', 07:03:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:03:27 INFO - 'MOZ_NO_REMOTE': '1', 07:03:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:03:27 INFO - 'NO_EM_RESTART': '1', 07:03:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:03:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:03:27 INFO - 'PWD': '/builds/slave/test', 07:03:27 INFO - 'SHELL': '/bin/bash', 07:03:27 INFO - 'SHLVL': '1', 07:03:27 INFO - 'TERM': 'linux', 07:03:27 INFO - 'TMOUT': '86400', 07:03:27 INFO - 'USER': 'cltbld', 07:03:27 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', 07:03:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:03:27 INFO - '_': '/tools/buildbot/bin/python'} 07:03:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:03:27 INFO - Downloading/unpacking jsonschema==2.5.1 07:03:27 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 07:03:27 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 07:03:27 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 07:03:27 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 07:03:27 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 07:03:27 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 07:03:29 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:03:29 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 07:03:29 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 07:03:29 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 07:03:29 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 07:03:29 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 07:03:29 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 07:03:29 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 07:03:29 INFO - Downloading functools32-3.2.3-2.tar.gz 07:03:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 07:03:29 INFO - warning: no files found matching '*.txt' 07:03:29 INFO - no previously-included directories found matching 'build' 07:03:29 INFO - no previously-included directories found matching 'dist' 07:03:29 INFO - no previously-included directories found matching '.git*' 07:03:29 INFO - Installing collected packages: jsonschema, functools32 07:03:29 INFO - Running setup.py install for functools32 07:03:29 INFO - warning: no files found matching '*.txt' 07:03:29 INFO - no previously-included directories found matching 'build' 07:03:29 INFO - no previously-included directories found matching 'dist' 07:03:29 INFO - no previously-included directories found matching '.git*' 07:03:29 INFO - Successfully installed jsonschema functools32 07:03:29 INFO - Cleaning up... 07:03:29 INFO - Return code: 0 07:03:29 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 07:03:29 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')]} 07:03:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:03:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:29 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')]} 07:03:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:03:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:29 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 0x2609030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x276c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2838400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c7570>, '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 0x28c8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28c8900>, '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': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', '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 07:03:29 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 07:03:29 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 07:03:29 INFO - Using env: {'DISPLAY': ':0', 07:03:29 INFO - 'HOME': '/home/cltbld', 07:03:29 INFO - 'LANG': 'en_US.UTF-8', 07:03:29 INFO - 'LANGUAGE': 'en_US:en', 07:03:29 INFO - 'LOGNAME': 'cltbld', 07:03:29 INFO - 'MAIL': '/var/mail/cltbld', 07:03:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:03:29 INFO - 'MOZ_NO_REMOTE': '1', 07:03:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:03:29 INFO - 'NO_EM_RESTART': '1', 07:03:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:03:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:03:29 INFO - 'PWD': '/builds/slave/test', 07:03:29 INFO - 'SHELL': '/bin/bash', 07:03:29 INFO - 'SHLVL': '1', 07:03:29 INFO - 'TERM': 'linux', 07:03:29 INFO - 'TMOUT': '86400', 07:03:29 INFO - 'USER': 'cltbld', 07:03:29 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', 07:03:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:03:29 INFO - '_': '/tools/buildbot/bin/python'} 07:03:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:03:29 INFO - Downloading/unpacking blobuploader==1.2.4 07:03:29 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 07:03:29 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 07:03:29 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 07:03:29 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 07:03:29 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 07:03:29 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 07:03:31 INFO - Downloading blobuploader-1.2.4.tar.gz 07:03:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:03:31 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:03:31 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 07:03:31 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 07:03:31 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 07:03:31 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 07:03:31 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 07:03:31 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 07:03:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 07:03:32 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:03:32 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 07:03:32 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 07:03:32 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 07:03:32 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 07:03:32 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 07:03:32 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 07:03:32 INFO - Downloading docopt-0.6.1.tar.gz 07:03:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 07:03:32 INFO - Installing collected packages: blobuploader, requests, docopt 07:03:32 INFO - Running setup.py install for blobuploader 07:03:32 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:03:32 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 07:03:32 INFO - Running setup.py install for requests 07:03:32 INFO - Running setup.py install for docopt 07:03:33 INFO - Successfully installed blobuploader requests docopt 07:03:33 INFO - Cleaning up... 07:03:33 INFO - Return code: 0 07:03:33 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:03:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 07:03:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:03:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 07:03:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:03:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:33 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 0x2609030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x276c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2838400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c7570>, '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 0x28c8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28c8900>, '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': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', '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 07:03:33 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 07:03:33 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 07:03:33 INFO - Using env: {'DISPLAY': ':0', 07:03:33 INFO - 'HOME': '/home/cltbld', 07:03:33 INFO - 'LANG': 'en_US.UTF-8', 07:03:33 INFO - 'LANGUAGE': 'en_US:en', 07:03:33 INFO - 'LOGNAME': 'cltbld', 07:03:33 INFO - 'MAIL': '/var/mail/cltbld', 07:03:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:03:33 INFO - 'MOZ_NO_REMOTE': '1', 07:03:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:03:33 INFO - 'NO_EM_RESTART': '1', 07:03:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:03:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:03:33 INFO - 'PWD': '/builds/slave/test', 07:03:33 INFO - 'SHELL': '/bin/bash', 07:03:33 INFO - 'SHLVL': '1', 07:03:33 INFO - 'TERM': 'linux', 07:03:33 INFO - 'TMOUT': '86400', 07:03:33 INFO - 'USER': 'cltbld', 07:03:33 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', 07:03:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:03:33 INFO - '_': '/tools/buildbot/bin/python'} 07:03:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:03:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:03:33 INFO - Running setup.py (path:/tmp/pip-PJTfCp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:03:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:03:33 INFO - Running setup.py (path:/tmp/pip-_KbUJ9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:03:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:03:33 INFO - Running setup.py (path:/tmp/pip-Edf3vz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:03:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:03:33 INFO - Running setup.py (path:/tmp/pip-N13KMo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:03:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:03:33 INFO - Running setup.py (path:/tmp/pip-QCezab-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:03:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:03:33 INFO - Running setup.py (path:/tmp/pip-m_0Nnf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:03:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:03:33 INFO - Running setup.py (path:/tmp/pip-cpF15A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:03:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:03:33 INFO - Running setup.py (path:/tmp/pip-mU7fBA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:03:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:03:33 INFO - Running setup.py (path:/tmp/pip-kPGvFd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:03:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:03:34 INFO - Running setup.py (path:/tmp/pip-LfOVrb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:03:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:03:34 INFO - Running setup.py (path:/tmp/pip-3nnkvi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:03:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:03:34 INFO - Running setup.py (path:/tmp/pip-B2ERuH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:03:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:03:34 INFO - Running setup.py (path:/tmp/pip-sPUMTw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:03:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:03:34 INFO - Running setup.py (path:/tmp/pip-hxU27j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:03:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:03:34 INFO - Running setup.py (path:/tmp/pip-oRkE9_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:03:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:03:34 INFO - Running setup.py (path:/tmp/pip-yz3oxC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:03:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:03:34 INFO - Running setup.py (path:/tmp/pip-BDD0GE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:03:34 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:03:34 INFO - Running setup.py install for manifestparser 07:03:34 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 07:03:34 INFO - Running setup.py install for mozcrash 07:03:34 INFO - Running setup.py install for mozdebug 07:03:34 INFO - Running setup.py install for mozdevice 07:03:35 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 07:03:35 INFO - Installing dm script to /builds/slave/test/build/venv/bin 07:03:35 INFO - Running setup.py install for mozfile 07:03:35 INFO - Running setup.py install for mozhttpd 07:03:35 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 07:03:35 INFO - Running setup.py install for mozinfo 07:03:35 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 07:03:35 INFO - Running setup.py install for mozInstall 07:03:35 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 07:03:35 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 07:03:35 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 07:03:35 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 07:03:35 INFO - Running setup.py install for mozleak 07:03:35 INFO - Running setup.py install for mozlog 07:03:35 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 07:03:35 INFO - Running setup.py install for moznetwork 07:03:35 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 07:03:35 INFO - Running setup.py install for mozprocess 07:03:35 INFO - Running setup.py install for mozprofile 07:03:35 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 07:03:35 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 07:03:35 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 07:03:35 INFO - Running setup.py install for mozrunner 07:03:36 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 07:03:36 INFO - Running setup.py install for mozscreenshot 07:03:36 INFO - Running setup.py install for moztest 07:03:36 INFO - Running setup.py install for mozversion 07:03:36 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 07:03:36 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:03:36 INFO - Cleaning up... 07:03:36 INFO - Return code: 0 07:03:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:03:36 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')]} 07:03:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:03:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:36 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')]} 07:03:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:03:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:36 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 0x2609030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x276c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2838400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c7570>, '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 0x28c8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28c8900>, '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': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', '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 07:03:36 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 07:03:36 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 07:03:36 INFO - Using env: {'DISPLAY': ':0', 07:03:36 INFO - 'HOME': '/home/cltbld', 07:03:36 INFO - 'LANG': 'en_US.UTF-8', 07:03:36 INFO - 'LANGUAGE': 'en_US:en', 07:03:36 INFO - 'LOGNAME': 'cltbld', 07:03:36 INFO - 'MAIL': '/var/mail/cltbld', 07:03:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:03:36 INFO - 'MOZ_NO_REMOTE': '1', 07:03:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:03:36 INFO - 'NO_EM_RESTART': '1', 07:03:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:03:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:03:36 INFO - 'PWD': '/builds/slave/test', 07:03:36 INFO - 'SHELL': '/bin/bash', 07:03:36 INFO - 'SHLVL': '1', 07:03:36 INFO - 'TERM': 'linux', 07:03:36 INFO - 'TMOUT': '86400', 07:03:36 INFO - 'USER': 'cltbld', 07:03:36 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', 07:03:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:03:36 INFO - '_': '/tools/buildbot/bin/python'} 07:03:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:03:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:03:36 INFO - Running setup.py (path:/tmp/pip-BWbcJ2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:03:36 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)) 07:03:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:03:36 INFO - Running setup.py (path:/tmp/pip-6Zloy3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:03:36 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)) 07:03:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:03:36 INFO - Running setup.py (path:/tmp/pip-upRGMM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:03:36 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)) 07:03:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:03:36 INFO - Running setup.py (path:/tmp/pip-DSTC66-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:03:36 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)) 07:03:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:03:36 INFO - Running setup.py (path:/tmp/pip-EYHr5h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:03:36 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)) 07:03:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:03:36 INFO - Running setup.py (path:/tmp/pip-H3eJ5B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:03:37 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)) 07:03:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:03:37 INFO - Running setup.py (path:/tmp/pip-DN8Dz3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:03:37 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)) 07:03:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:03:37 INFO - Running setup.py (path:/tmp/pip-n0pBo2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:03:37 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)) 07:03:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:03:37 INFO - Running setup.py (path:/tmp/pip-8RrND6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:03:37 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)) 07:03:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:03:37 INFO - Running setup.py (path:/tmp/pip-zWiygD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:03:37 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)) 07:03:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:03:37 INFO - Running setup.py (path:/tmp/pip-yD_yHA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:03:37 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)) 07:03:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:03:37 INFO - Running setup.py (path:/tmp/pip-MLXQOT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:03:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 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)) 07:03:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:03:37 INFO - Running setup.py (path:/tmp/pip-OX4hBk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:03:37 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)) 07:03:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:03:37 INFO - Running setup.py (path:/tmp/pip-mF2zjl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:03:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 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)) 07:03:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:03:37 INFO - Running setup.py (path:/tmp/pip-avWZkX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:03:37 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)) 07:03:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:03:37 INFO - Running setup.py (path:/tmp/pip-kV8i4z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:03:37 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)) 07:03:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:03:37 INFO - Running setup.py (path:/tmp/pip-LE0GMs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:03:37 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)) 07:03:37 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)) 07:03:37 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)) 07:03:37 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)) 07:03:37 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)) 07:03:37 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)) 07:03:37 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 07:03:37 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 07:03:37 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 07:03:37 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 07:03:37 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 07:03:37 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 07:03:37 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 07:03:39 INFO - Downloading blessings-1.6.tar.gz 07:03:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 07:03:39 INFO - Installing collected packages: blessings 07:03:39 INFO - Running setup.py install for blessings 07:03:39 INFO - Successfully installed blessings 07:03:39 INFO - Cleaning up... 07:03:39 INFO - Return code: 0 07:03:39 INFO - Done creating virtualenv /builds/slave/test/build/venv. 07:03:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:03:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:03:40 INFO - Reading from file tmpfile_stdout 07:03:40 INFO - Current package versions: 07:03:40 INFO - argparse == 1.2.1 07:03:40 INFO - blessings == 1.6 07:03:40 INFO - blobuploader == 1.2.4 07:03:40 INFO - docopt == 0.6.1 07:03:40 INFO - functools32 == 3.2.3-2 07:03:40 INFO - jsonschema == 2.5.1 07:03:40 INFO - manifestparser == 1.1 07:03:40 INFO - mozInstall == 1.12 07:03:40 INFO - mozcrash == 0.17 07:03:40 INFO - mozdebug == 0.1 07:03:40 INFO - mozdevice == 0.48 07:03:40 INFO - mozfile == 1.2 07:03:40 INFO - mozhttpd == 0.7 07:03:40 INFO - mozinfo == 0.9 07:03:40 INFO - mozleak == 0.1 07:03:40 INFO - mozlog == 3.2 07:03:40 INFO - moznetwork == 0.27 07:03:40 INFO - mozprocess == 0.22 07:03:40 INFO - mozprofile == 0.28 07:03:40 INFO - mozrunner == 6.11 07:03:40 INFO - mozscreenshot == 0.1 07:03:40 INFO - mozsystemmonitor == 0.3 07:03:40 INFO - moztest == 0.7 07:03:40 INFO - mozversion == 1.4 07:03:40 INFO - psutil == 3.1.1 07:03:40 INFO - requests == 1.2.3 07:03:40 INFO - wsgiref == 0.1.2 07:03:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:03:40 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')]} 07:03:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:03:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:40 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')]} 07:03:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:03:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:40 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 0x2609030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x276c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2838400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c7570>, '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 0x28c8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28c8900>, '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': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', '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 07:03:40 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 07:03:40 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 07:03:40 INFO - Using env: {'DISPLAY': ':0', 07:03:40 INFO - 'HOME': '/home/cltbld', 07:03:40 INFO - 'LANG': 'en_US.UTF-8', 07:03:40 INFO - 'LANGUAGE': 'en_US:en', 07:03:40 INFO - 'LOGNAME': 'cltbld', 07:03:40 INFO - 'MAIL': '/var/mail/cltbld', 07:03:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:03:40 INFO - 'MOZ_NO_REMOTE': '1', 07:03:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:03:40 INFO - 'NO_EM_RESTART': '1', 07:03:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:03:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:03:40 INFO - 'PWD': '/builds/slave/test', 07:03:40 INFO - 'SHELL': '/bin/bash', 07:03:40 INFO - 'SHLVL': '1', 07:03:40 INFO - 'TERM': 'linux', 07:03:40 INFO - 'TMOUT': '86400', 07:03:40 INFO - 'USER': 'cltbld', 07:03:40 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', 07:03:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:03:40 INFO - '_': '/tools/buildbot/bin/python'} 07:03:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:03:40 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)) 07:03:40 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)) 07:03:40 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)) 07:03:40 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)) 07:03:40 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)) 07:03:40 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)) 07:03:40 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)) 07:03:40 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)) 07:03:40 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)) 07:03:40 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)) 07:03:40 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)) 07:03:40 INFO - Cleaning up... 07:03:40 INFO - Return code: 0 07:03:40 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 07:03:40 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')]} 07:03:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:03:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:40 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')]} 07:03:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:03:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:03:40 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 0x2609030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x276c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2838400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c7570>, '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 0x28c8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28c8900>, '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': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', '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 07:03:40 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 07:03:40 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 07:03:40 INFO - Using env: {'DISPLAY': ':0', 07:03:40 INFO - 'HOME': '/home/cltbld', 07:03:40 INFO - 'LANG': 'en_US.UTF-8', 07:03:40 INFO - 'LANGUAGE': 'en_US:en', 07:03:40 INFO - 'LOGNAME': 'cltbld', 07:03:40 INFO - 'MAIL': '/var/mail/cltbld', 07:03:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:03:40 INFO - 'MOZ_NO_REMOTE': '1', 07:03:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:03:40 INFO - 'NO_EM_RESTART': '1', 07:03:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:03:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:03:40 INFO - 'PWD': '/builds/slave/test', 07:03:40 INFO - 'SHELL': '/bin/bash', 07:03:40 INFO - 'SHLVL': '1', 07:03:40 INFO - 'TERM': 'linux', 07:03:40 INFO - 'TMOUT': '86400', 07:03:40 INFO - 'USER': 'cltbld', 07:03:40 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', 07:03:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:03:40 INFO - '_': '/tools/buildbot/bin/python'} 07:03:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:03:40 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 07:03:40 INFO - Cleaning up... 07:03:40 INFO - Return code: 0 07:03:40 INFO - Running post-action listener: _resource_record_post_action 07:03:40 INFO - Running post-action listener: _start_resource_monitoring 07:03:40 INFO - Starting resource monitoring. 07:03:40 INFO - ##### 07:03:40 INFO - ##### Finished create-virtualenv step (success) 07:03:40 INFO - ##### 07:03:40 INFO - ##### 07:03:40 INFO - ##### Running install step. 07:03:40 INFO - ##### 07:03:40 INFO - Running pre-action listener: _resource_record_pre_action 07:03:40 INFO - Running main action method: install 07:03:40 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:03:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:03:40 INFO - Reading from file tmpfile_stdout 07:03:40 INFO - Detecting whether we're running mozinstall >=1.0... 07:03:40 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 07:03:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 07:03:40 INFO - Reading from file tmpfile_stdout 07:03:40 INFO - Output received: 07:03:40 INFO - Usage: mozinstall [options] installer 07:03:40 INFO - Options: 07:03:40 INFO - -h, --help show this help message and exit 07:03:40 INFO - -d DEST, --destination=DEST 07:03:40 INFO - Directory to install application into. [default: 07:03:40 INFO - "/builds/slave/test"] 07:03:40 INFO - --app=APP Application being installed. [default: firefox] 07:03:40 INFO - mkdir: /builds/slave/test/build/application 07:03:40 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'] 07:03:40 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 07:03:57 INFO - Reading from file tmpfile_stdout 07:03:57 INFO - Output received: 07:03:57 INFO - /builds/slave/test/build/application/firefox/firefox 07:03:57 INFO - Running post-action listener: _resource_record_post_action 07:03:57 INFO - ##### 07:03:57 INFO - ##### Finished install step (success) 07:03:57 INFO - ##### 07:03:57 INFO - ##### 07:03:57 INFO - ##### Running run-tests step. 07:03:57 INFO - ##### 07:03:57 INFO - Running pre-action listener: _resource_record_pre_action 07:03:57 INFO - Running main action method: run_tests 07:03:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 07:03:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 07:03:57 INFO - Python 2.7.3 07:03:57 INFO - Return code: 0 07:03:57 INFO - grabbing minidump binary from tooltool 07:03: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')]} 07:03:57 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 0x28c7570>, '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 0x28c8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28c8900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 07:03:57 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 07:03:57 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 07:03:57 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 07:03:57 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:03:57 INFO - Return code: 0 07:03:57 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 07:03:57 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 07:03:57 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 07:03:57 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 07:03:57 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 07:03:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-049', '--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 07:03:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-049 --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 07:03:57 INFO - Using env: {'DISPLAY': ':0', 07:03:57 INFO - 'HOME': '/home/cltbld', 07:03:57 INFO - 'LANG': 'en_US.UTF-8', 07:03:57 INFO - 'LANGUAGE': 'en_US:en', 07:03:57 INFO - 'LOGNAME': 'cltbld', 07:03:57 INFO - 'MAIL': '/var/mail/cltbld', 07:03:57 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 07:03:57 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 07:03:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:03:57 INFO - 'MOZ_NO_REMOTE': '1', 07:03:57 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 07:03:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:03:57 INFO - 'NO_EM_RESTART': '1', 07:03:57 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:03:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:03:57 INFO - 'PWD': '/builds/slave/test', 07:03:57 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 07:03:57 INFO - 'SHELL': '/bin/bash', 07:03:57 INFO - 'SHLVL': '1', 07:03:57 INFO - 'TERM': 'linux', 07:03:57 INFO - 'TMOUT': '86400', 07:03:57 INFO - 'USER': 'cltbld', 07:03:57 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895', 07:03:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:03:57 INFO - '_': '/tools/buildbot/bin/python'} 07:03:57 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-049', '--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 07:03:57 INFO - mozversion application_buildid: 20160701062022 07:03:57 INFO - mozversion application_changeset: 1aca6ed481adc49038a6af063c79eaf494fd6125 07:03:57 INFO - mozversion application_display_name: Nightly 07:03:57 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:03:57 INFO - mozversion application_name: Firefox 07:03:57 INFO - mozversion application_remotingname: firefox 07:03:57 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 07:03:57 INFO - mozversion application_vendor: Mozilla 07:03:57 INFO - mozversion application_version: 50.0a1 07:03:57 INFO - mozversion platform_buildid: 20160701062022 07:03:57 INFO - mozversion platform_changeset: 1aca6ed481adc49038a6af063c79eaf494fd6125 07:03:57 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 07:03:57 INFO - mozversion platform_version: 50.0a1 07:03:57 INFO - using testdate: 1467381837 07:03:57 INFO - actual date: 1467381837 07:03:57 INFO - starting webserver on 'localhost:37786' 07:03:57 INFO - SUITE-START | Running 2 tests 07:03:57 INFO - TEST-START | dromaeo_css 07:03:57 INFO - operating with platform_type : linux_ 07:03:57 INFO - Initialising browser for dromaeo_css test... 07:03:57 INFO - TEST-INFO | started process 4639 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2h0TvZ/profile http://localhost:37786/getInfo.html) 07:04:02 INFO - PROCESS | 4639 | __metrics Screen width/height:1600/1200 07:04:02 INFO - PROCESS | 4639 | colorDepth:24 07:04:02 INFO - PROCESS | 4639 | Browser inner width/height: 1024/697 07:04:02 INFO - PROCESS | 4639 | __metrics 07:04:03 ERROR - PROCESS | 4639 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 07:04:04 INFO - TEST-INFO | 4639: exit 0 07:04:04 INFO - Browser initialized. 07:04:04 INFO - Running cycle 1/1 for dromaeo_css test... 07:04:04 INFO - TEST-INFO | started process 4758 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2h0TvZ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:04:16 INFO - PROCESS | 4758 | RSS: Main: 169406464 07:04:16 INFO - PROCESS | 4758 | 07:05:05 INFO - PROCESS | 4758 | 1467381905841 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] 07:07:17 INFO - PROCESS | 4758 | Cycle 1(1): loaded http://localhost:37786/tests/dromaeo/cssquery-dojo.html (next: http://localhost:37786/tests/dromaeo/cssquery-ext.html) 07:07:19 INFO - PROCESS | 4758 | RSS: Main: 168448000 07:07:19 INFO - PROCESS | 4758 | 07:10:21 INFO - PROCESS | 4758 | Cycle 1(1): loaded http://localhost:37786/tests/dromaeo/cssquery-ext.html (next: http://localhost:37786/tests/dromaeo/cssquery-jquery.html) 07:10:21 INFO - PROCESS | 4758 | RSS: Main: 168747008 07:10:21 INFO - PROCESS | 4758 | 07:13:23 INFO - PROCESS | 4758 | Cycle 1(1): loaded http://localhost:37786/tests/dromaeo/cssquery-jquery.html (next: http://localhost:37786/tests/dromaeo/cssquery-mootools.html) 07:13:24 INFO - PROCESS | 4758 | RSS: Main: 171601920 07:13:24 INFO - PROCESS | 4758 | 07:16:26 INFO - PROCESS | 4758 | Cycle 1(1): loaded http://localhost:37786/tests/dromaeo/cssquery-mootools.html (next: http://localhost:37786/tests/dromaeo/cssquery-prototype.html) 07:16:26 INFO - PROCESS | 4758 | RSS: Main: 167546880 07:16:26 INFO - PROCESS | 4758 | 07:19:29 INFO - PROCESS | 4758 | Cycle 1(1): loaded http://localhost:37786/tests/dromaeo/cssquery-prototype.html (next: http://localhost:37786/tests/dromaeo/cssquery-yui.html) 07:19:30 INFO - PROCESS | 4758 | RSS: Main: 169107456 07:19:30 INFO - PROCESS | 4758 | 07:22:32 INFO - PROCESS | 4758 | Cycle 1(1): loaded http://localhost:37786/tests/dromaeo/cssquery-yui.html (next: http://localhost:37786/tests/dromaeo/cssquery-dojo.html) 07:22:33 INFO - PROCESS | 4758 | RSS: Main: 170393600 07:22:33 INFO - PROCESS | 4758 | 07:22:33 INFO - PROCESS | 4758 | __start_tp_report 07:22:33 INFO - PROCESS | 4758 | _x_x_mozilla_page_load 07:22:33 INFO - PROCESS | 4758 | _x_x_mozilla_page_load_details 07:22:33 INFO - PROCESS | 4758 | |i|pagename|runs| 07:22:33 INFO - PROCESS | 4758 | |0;dojo.html;2598.298459415958;2645.2989957661234;2657.3888005758677;2681.5307321218793;2681.9463610727785;4826.8069277228915;4850.9514904850985;4883.29192267121;4907.582855457282;4922.901541969159;4727.1254817858635;4765.952340476594;4787.832425865086;4811.061842940628;4870;4321.481422229337;4396.472423309207;4454.3318502224765;4456.59890609845;4488.236999710057;4444.044530425957;4513.277875539914;4530.456345238576;4552.9089418211615;4572.977135114336;4249.383839343293;4264.211120942636;4311.094670119279;4349.173657005159;4388.319810429357;4333.783310834446;4407.823687052514;4436.401085853401;4441.067375851075;4447.08834688888;4374.103308821684;4391.385206071152;4423.845165419227;4430.468343798732;4443.800028998703;4782.976085119587;4871.902561948777;4873.02539492103;4880.487548807359;4926.975365123188;5213.973930130363;5215.035218484592;5224.03355379256;5244.685318880879;5254.658447200958;4984.700917944935;5147.794088236466;5172.870678233036;5185.922211166836;5203.60972927032;4822.493638168012;4835.661503694742;4859.392575928009;4899.436564795023;4916.680415772963;5336.092864213093;5340.06548853949;5350.143976963667;5354.518093371616;5359.330083739533;4986.276989836453;4996.400431948189;5030.597552195815;5060.671056381323;5136.178211486144;5079.390473143247;5121.129408000649;5153.3815942087185;5181.119209734355;5201.713905735221;5089.236614507779;5093.159628661229;5126.846194614168;5130.615203859726;5135.229715542624;4998.450170481244;5021.5229553192385;5048.444671086178;5094.032133894548;5139.152039913447;4343.370211319341;4344.391785150082;4346.695731298779;4357.7385356878685;4402.471703395613;3803.0897620585056;3812.989557767194;3827.827747751358;3829.885103446901;3842.538895332578;4395.406620106309;4397.2964325707735;4479.731216127043;4482.327650852333;4484.439445069366;5226.608004399685;5227.529522342931;5236.6857988520815;5247.606429517801;5258.316418865523;4345.891352716208;4499.482559505699;4509.368688383629;4518.322251662277;4519.683622146418;4595.517470665532;4644.349791029259;4661;4663.650226233046;4682.321063445849;4798.95201047985;4865.1242776300605;4872.6589138761365;4882.707037577757;4896.804127834846;5082.567981721447;5152.252923326172;5218.504242096995;5240.947590524046;5285.339332583427;4780.976095119502;4862.31927530139;4862.927056094232;4868.099401610713;4880.389951256093;5141.7686204120155;5149.021685879671;5158.226266060121;5171.63798534099;5226.11156103471;5038.294638750651;5076.568491678248;5211.635185536976;5221.582273418194;5236.031334203185;4848.5636292732415;4919.311296418433;4921.04039712267;4929.901401971869;4992.375953005874;4995.100881841304;5017.147084995632;5039.949600503948;5045.571126454292;5089.287499750112;4816;4959.156943319572;4984.651074424755;4989.376327959005;5014.147594908802;4909.140900342497;5011.5489605935645;5020.071286811952;5037.974810125926;5043.420006699276;4868.2210846264425;4895.46149923501;4920.803167873388;4935.235038569028;5001.299818025406 07:22:33 INFO - PROCESS | 4758 | |1;ext.html;522.8793830932633;593.9792107276246;598.0520874414053;599.3646734461469;615.2186722861968;35496.290074198536;38594.8070259649;38617.42073868894;38705.419418708705;38811.22377552447;38942.61057389425;39237.41143882837;39526;39567;39653.801730991305;7691.730789422385;7817.491863028913;7819.218078192163;7825.256600622932;7829.765107046797;7724.34343080836;7796.844063118734;7807.765767026998;7808.5314881107315;7826.921730782677;7777.494462859924;7791.688332466694;7825.060992680887;7833.804154896145;7867.252611001945;7777.533347999138;7778.3777297816605;7778.6888524458955;7789.298963093349;7798.376129909594;7749.806254843617;7772.222777722182;7783.805404864867;7786.1435242123325;7817.648205830695;37593;38142.42786358207;38272.808635956644;38285.42571861424;38385.61614383848;2976.821390716564;3072.9692703072906;3083.04425628056;3202.9199270018203;3215.855286512089;29323.70676293231;29538.55692164619;29998;30091.097267081805;30844;3378.3581119587448;3379.2227787608986;3467.2718729066673;3473.426884564044;3534.68187863091;250703;251625.48374516203;252223;252260;252839;54574;55083.17375239375;55171.72414137984;55291;55626.443735562934;33223.16942076419;33896.32207355839;34469.827650862084;36454.63545364566;58481.70759146262;14973.775393369107;15048.849511504965;15159.924200379148;15185.924070379577;15192.392304307925;11393.943030284961;11408.258463199865;11490.138239631893;11515.366654833897;11524.250923689933;18303;18583.628327433376;18628.254869805056;18671.90664046671;18788.248470061317;6877.346652068046;6909.75815846453;6915.239323674392;7057.717691292393;7064.43484521237;791.133708589094;860.2558786649503;999.6351331763854;1028.0747327405395;1034.9223808214415;29038.854805725838;29407.1540900129;29527.55708664372;29552.261193469905;29600.111996640135;907.8320510705408;974.2352253481125;999.6201443451442;1003.3277703938379;1071.212658695858;15012.399504019717;15050.774238386433;15132.697346053017;15285.465008724641;15458.84541154574;395496;398950;400501;401530;402263;50436;50744.74627626838;50889.49110508922;50896.74551627218;51054.744726276134;1136.687410961992;1198.2391181599746;1200.4717924113363;1218.1716432825585;1225.7140433092397;25916.222513324632;27747;27755;27862.721372786014;27985.86007070033;42692.35961460643;42857.57142428536;42999.14001720011;43143.56856431521;43350.34974475322;343163;344282;344578;345082;347226;25697.486050278516;25926.61110083388;26057.348566285993;26250.212493625222;26260.60609090827;42251.57748422599;43224.35163472613;43308;43390.34914476222;43442.34836477392;36551.26897462089;36844;36968.63031369652;37386.43920341251;37546.249075018895;37159.44260836144;37742.43386349262;37835;37995.43006854955;38016.809915950245;32693.34613307768;36230.09424764402;36495.45256821097;36933.076673083386;37098;32042.51936220912;33579.49630755589;33732;33749;33912.660873391935;26025.6096158554;26154.215373538824;26321.60517592276;26373.34066648349;26507.33731656724 07:22:33 INFO - PROCESS | 4758 | |2;jquery.html;361.94208926571747;365.8865751616999;367.5332327943512;380.7516614392014;385.2141631072612;15800.762988555181;15908;16003.919980400111;16018.359265629375;16758.581035474104;16243.593910152253;16763.24565394557;17462;17475.213615387307;17481.82518174818;5107.182850743891;5211.661242019276;5264.710440925747;5267.104592219332;5279.2872962150195;3800.9809950950207;5161.896762064756;5684.488396044355;6009.669468179271;6017.458428741413;6048.818535443944;6053.848653783669;6067.332593414743;6075.149479072933;6100.511959043266;5101.974490127563;5383.43473935237;5387.299651045359;5401.297831281908;5418.729063546807;5198.558122559587;5240.213967904845;5285.524302812765;5333.173358129496;5341.278927344798;20401.285954991654;20641;20662.793372066237;21183.788162118337;21235.893820530953;1934;1986.4835142862814;1989.3932350633052;2245.315178870444;2298.679376427369;9366;9611.183049440806;12638;12682.492700291978;13476.460941562325;1586.8333824948445;1706.9658606827918;1717.6392957478945;1752.1151818331662;1763.2682436788718;67127.3287267126;69429.65285173593;70115.64942175256;70365.2963470369;71665;8442.409031367746;8755.824883502422;9101.81796364069;9176.770580735534;9487.33588648788;12042.578509752117;12102.697432564257;12190.634280971584;12295.077869159848;12300.507979680713;6749.8650026999185;6915.239323674392;6918.7232510699005;6932.6533673316135;7093.1488221413765;6698.363655452724;6782.8643427132165;6787.321267873173;6939.514234003571;6944.618046007518;3841.9039524012123;3914.823832927525;3916.5104361954754;3965.464662270614;4004.9199016019516;1726.4389073551147;1749.588846621043;1827.378691244983;1882.5575989642423;1908.5801123752751;779.3570304498697;838.7861095420628;866.1728049712635;916.2349438219028;917.5870858113875;17119.14404279781;17217.31130754756;17361.56596085108;17675.381361652282;17720.20259088344;865.3899001204136;868.9826203475895;878.5255961780695;881.5371929736939;891.4517571693361;9539;9813;9932;9935.354201976848;9969.052939970692;367207;367288;423252;430378;431469;79138.20861791309;85853.57073214593;86329;86604.1339586596;87130;900.504722402676;901.6438506789781;934.3833070173653;943.4952300519326;945.8770359853175;14357.066790658573;15350.846491534941;16131.435399760952;16261.105639189958;16886.324547017983;26510.072147474744;26708;26922.461550769265;30981;36841;53670;53827.730861345444;53889;54295;54591.72704136454;6817.829554261183;7908.604569771604;7909.05091389037;7994.720184793504;8016.83966320682;11770.3526306054;11829.231099978473;12397.380130993595;12478.563250286197;12553.121281510206;9908.554115064984;9972.50137493137;9989.150922171697;10358.585656573954;10655.413952232391;10809.56761729522;10948.288361256493;10981;11078.224524283223;11216.887831121585;10146.340487868265;10160.23798215122;10311.014263074425;10326.173906087344;10356.948215258875;7234.385077268491;7405.555666659802;7418.258174182539;7425.70297188128;7459.142198647008;9920.355176913477;10324.741881453023;10414.895851041392;10882.673519794418;10929.945350273198 07:22:33 INFO - PROCESS | 4758 | |3;mootools.html;1381.0608786025505;1425.33721819354;1501.7822415749717;1695.4150817967811;1699.5836020175052;7003.684834182462;7480.177180510146;7743;8012.479188852721;8060.919390806091;7845.450818442711;7868.960655196716;7930.286274235317;7941.722039728611;7943.443958922863;2200.7909248621354;2215.7230346206725;2234.731832180141;2236.541508990653;2237.944051398712;2204.459907322708;2236.2396785093065;2236.5079682469914;2237.9776202238013;2237.9888100559474;2206.6138425775507;2211.6019116559014;2219.079082180893;2220.7224096987875;2231.0518029837335;2132.1258284103596;2157.751858536265;2162.027087810484;2169.8155656769195;2171.576542574199;2176.3470958712323;2184.071769497957;2184.90167942443;2188.5075857931997;2190.7042549255966;7911.762647120596;7996.520208787491;8015.398845086642;8029.116797152308;8061.95969020157;4480.641548676098;4576.794044268016;4578.2903649934315;4582.6104781093645;4616.53834616539;2942.440936222111;2953.069783018342;2961.392914452532;2998.6551546572205;3045.1321373408696;911.2072496927649;935.1023017902821;941.8210539997447;949.3070058857073;985.3693636072919;10620.46897655122;10656.09423199029;10687.198460115522;10699.304545204537;10718.142548596172;4132.690048246393;4298.591633794785;4347.630451411602;4420.447444069491;4424.225760491901;9125.634974600942;9136.497492637836;9151.130642588943;9156.725298241063;9203.217726493189;4630.189716799547;4639.536046395401;4640.141573808789;4641.930371044437;4647.790849411785;3798.1074447504816;4058.6753059755147;4185.121124563815;4205;4213.220554197484;3625.329314076904;3727.459518369821;3752.249550089993;3826.6364695353896;3836.67388272;1147.822087576427;1196;1213.611644273824;1222.4010234984794;1223.565634199864;844.7550210439027;846.3863698818308;847.6439895244013;866.4108406283661;870.1776820904312;5136.126858434075;5273.499017593323;5290.81482148123;5302.496262855023;5407.729613519308;417.611621192288;420.5416096454879;421.1408726198521;431.25393069989093;434.1902352113349;3503.4394496880377;3554.733394995386;3586.2110335726097;3602.1174812171184;3627.637236276404;9111.316651251183;9834;9849.901500985041;9855.35940163887;9929.602815887283;9554.713358599252;9751.073648003428;9807.460589667495;9845.950770246103;9849.064338887794;7448.813779655552;7517.812054698677;7562.962185189149;7564.357029652431;7576.5832879191075;5029.622778291716;5063.87340316495;5101.20931255656;5152.5620322271525;5289.312389389354;8992.910070899206;9043.63825447001;9048.683296084606;9104.317176211678;9112.088791120836;8860.778480538038;9071.09289071114;9409.529523523659;9425.905740942777;9438.48088355147;6922.688479018557;6960.408365288805;7012.018317435665;7060.858782824212;7086.716531338689;7543.283388078124;7601.543907365576;7607.125180604301;7607.657655405631;7641.923580764121;6360.49116070704;6436.6459844707115;6462.644554549545;6525.7063432146615;6586.868262634624;6685.364890335411;6724.361185687352;6731.865362692621;6780.050792889098;6882.414994725505;6038.456538911519;6065.302490213506;6098.146259523582;6113.816585502442;6157.476614487819;4505.594496495331;4541.182587134347;4608.700434471749;4613.630909527163;4634.351190833353;4352.608265256015;4370.300751879684;4406.82372705101;4435.068635586434;4481.193385190697 07:22:33 INFO - PROCESS | 4758 | |4;prototype.html;300.79846502843094;301.5175718849841;307.2533743004499;308.0604157320173;310.14864197777104;5121.795128194873;5138;5138;5145.4340022597535;5180.45605211453;5029.396472423315;5067.619928505368;5073.441921388644;5073.771680274387;5090.338256026721;3751.7936513491745;3874.748141370802;3969.1267921057465;3973.9006524836823;3979;3956.3076461619244;3956.7823769692654;3974.125692347679;3978.1844721831953;4009.158076803875;3978.1645854370618;3984.6812255019527;3985.501812273466;4010.0952047777364;4018.959810401888;3726.4782930389765;3900.7854567998747;3908.9804550977346;4006.0585762345827;4016.979915100435;3404.42124838778;3428.0915557377316;3428.3828910796046;3429.3998550253605;3432.056184549244;4942.87642808929;4956.3804524434445;4970.6520543561965;4983.551480366748;5005.799768009275;4306.913861722779;4519.864404067883;4522.072975040109;4528.50186479487;4546.909061818778;5288.81489147878;5323.467653234646;5340.359156901197;5341.759620817073;5343.225232341328;3765.8870233893026;3774.112943528236;3775.528058992626;3775.754575952554;3790.336691079078;5394.919076213899;5551.77792888284;5576.525995290405;5583.106702927553;5610.326760788691;3845.8653947111716;3862.903427414281;3872.206197729459;3875.1862108957434;3876.8643097492018;3873.4964454620717;3891.494105766232;3903.911407397086;3910.687145028391;3921.8039098044983;4484.484284307347;4501.051811063759;4501.167284052461;4501.594856462934;4537.705049171794;5174.663646863017;5308.761105750251;5337.653052551572;5342;5374.086405311106;1332.9933350333185;1334.726381091874;1340.4169186403944;1345.2735522817568;1345.896364980726;840.7687885831446;856.2978357746713;857;864.1574464896676;896.5875697179371;4611.469680986663;4654.325122857234;4659.510751371125;4665.440147182359;4673.579377855941;5378.731063446812;5421.972890135524;5428.7557059931605;5461.290032295776;5503.862403439946;4518.661100417482;4623.468301145344;4627.8611641650805;4652.860414187579;4669.486356500782;2869.153599688097;2878.784091193169;2901.2166714987256;2910.6507219133414;2938.8971386001813;5049.394072711225;5049.611356876888;5068.138416469209;5080.466551012164;5088.9745551272745;5269.710165940834;5514.503694667499;5522.696251706115;5529.612927095065;5560.193771903132;4985.800567977313;5023.7488125592845;5023.8492845214705;5052.191649336162;5056.292119103328;5386.084365657926;5416.918746218731;5424.80654256063;5427.263275751721;5466.671999680032;5087.262346959744;5194.558462530727;5305.522502974751;5312.335958005249;5313.574914006793;5026.924596130988;5045.646804723634;5047.662369472019;5078.619103567321;5090.440051594395;3825.6556909878245;3837.328467518229;3843.4619153319118;3862.2082473092387;3871.670907972741;5241.570872612636;5481.890362192654;5550.55595552363;5556.611037227355;5572.804951826666;5417.891642167214;5418.83743487696;5427.945720542744;5450.182472629137;5464.207689885024;5229.450907654794;5347.0375332440535;5415;5420.674759514442;5453.318335208099;5318.883034562785;5335.733213339395;5341.35903691544;5345.358556973188;5399.568034557147;5215.295935048872;5217.921731173959;5414.729263536886;5428.83713488596;5436.755346009518;5286.656367336111;5320.760565774472;5324.281222034976;5338.652987555796;5350.5184533392185 07:22:33 INFO - PROCESS | 4758 | |5;yui.html;635.1806170040647;639.4532674563251;668.6489592963694;704.1690804850275;735.0627949364559;11946.522139114435;12597.811032834492;12608.936955315223;12624.684382890433;12655.303958282291;13198.53805116821;13654.52209172679;14377;14386.928065359685;14395.568132956001;637.9904301435482;773.9883901741479;781.1290411191509;798.0981490915258;802.5265093594778;790.8853216283635;808.0949336742827;809.7165991902846;810.9513429194237;811.2820154163549;859.1709000814213;861.67687117331;861.7845538615346;862.3187681731456;863.2662237098478;843.6119385082869;846.9280111190525;849.4987957105276;850.0479463001416;850.7277671145235;622.0700053420165;624.4504835744516;626.1328060636051;626.1640709652619;628.8805127025851;14442.205678687667;14578;14596.416143354252;14614.707705845929;14662.26688665573;14181.716365672732;14254.287285635677;14328.14031158134;14365.13809171453;14376;10373.651425314736;10524.47377631123;10660.200484963581;11051.778964420666;11257.71855703614;3363.091965169415;3368.9326213475592;3387.7459190560808;3459.0141809584147;3490.354284457358;58531;59025.7048714758;59806.10290845641;59937.40062599405;59972.400275997556;10807.567697292021;10911.290766100337;11176.608818691308;11306.830397544043;11792.88207117935;19893.502662433555;20299.28952486656;20379.694304585442;20407.081681324376;20463.8976805118;7209.747658831916;7255.52839065459;7365.558066515919;7490;7539.886901696479;3718.5537735471917;3821.8471261149243;3859.710521710883;3870.9225815484097;3887.8639247626197;2904.796664233483;2980.478416277143;2995.1164406500134;3001.5347621118763;3018.879244830226;513.586562816936;517.3817288340397;523.233462976741;526.2211926349025;532.2893936594612;503.3632454944498;621.3134486392562;633.5121956093782;636.096742625473;638.4732595608549;7751.612419379008;7988.081370642334;8106.189381061965;8402.453840500348;8618.569071546397;590.8611476303065;618.2519151826251;625.5452454595917;641.6214433484266;656;3919.1573811630637;3987.5813039631003;3997.980010099989;4002.1795531915886;4010.6189911958318;53205.46794532082;53383.199252011254;53464.46535534673;56918;98918;82990;84159.57920210483;84524.57737711273;84558;86343.56828215819;71400;72854.63572682103;72949;73464.26535734574;73468;7286.562806231643;7340.632968351668;7467.477276590804;7469.7012119516785;7668.233176682287;44414.3337849939;46489.30266045944;46499.30251046304;47142.764286178346;47599.52400475951;61718.69140654447;66352;67459.66270168617;67524;67545;9846.31075824714;10087.24345674092;10177.236707247133;10192.337498062601;10439.58241670355;10175.084242418217;10488.68533943983;10623.36259824413;10681;10720.73198170052;10043.196544276587;10065.798684026426;10139.594416223563;10273.845892311472;10625.362478251329;10616.469176540988;10802.351858888178;10872.347659140476;10932;11078.667639970814;9914.405135691593;10316.381017138996;10410.427426491615;10462.267641265038;10661.733456663334;8735.475871447734;8788.560571971504;9063.456192628464;9067.954660226656;9085.863712044193;8265.297449716601;8868.512231827312;8901.376903616685;9007;9158.221551168226 07:22:33 INFO - PROCESS | 4758 | __end_tp_report 07:22:33 INFO - PROCESS | 4758 | __start_cc_report 07:22:33 INFO - PROCESS | 4758 | _x_x_mozilla_cycle_collect,424 07:22:33 INFO - PROCESS | 4758 | __end_cc_report 07:22:33 INFO - PROCESS | 4758 | __startTimestamp1467382953138__endTimestamp 07:22:33 INFO - PROCESS | 4758 | 07:22:33 INFO - PROCESS | 4758 | ------- Summary: start ------- 07:22:33 INFO - PROCESS | 4758 | Number of tests: 6 07:22:33 INFO - PROCESS | 4758 | 07:22:33 INFO - PROCESS | 4758 | [#0] dojo.html Cycles:165 Average:4766.63 Median:4895.46 stddev:509.97 (10.4%) stddev-sans-first:482.33 07:22:33 INFO - PROCESS | 4758 | Values: 2598.3 2645.3 2657.4 2681.5 2681.9 4826.8 4851.0 4883.3 4907.6 4922.9 4727.1 4766.0 4787.8 4811.1 4870.0 4321.5 4396.5 4454.3 4456.6 4488.2 4444.0 4513.3 4530.5 4552.9 4573.0 4249.4 4264.2 4311.1 4349.2 4388.3 4333.8 4407.8 4436.4 4441.1 4447.1 4374.1 4391.4 4423.8 4430.5 4443.8 4783.0 4871.9 4873.0 4880.5 4927.0 5214.0 5215.0 5224.0 5244.7 5254.7 4984.7 5147.8 5172.9 5185.9 5203.6 4822.5 4835.7 4859.4 4899.4 4916.7 5336.1 5340.1 5350.1 5354.5 5359.3 4986.3 4996.4 5030.6 5060.7 5136.2 5079.4 5121.1 5153.4 5181.1 5201.7 5089.2 5093.2 5126.8 5130.6 5135.2 4998.5 5021.5 5048.4 5094.0 5139.2 4343.4 4344.4 4346.7 4357.7 4402.5 3803.1 3813.0 3827.8 3829.9 3842.5 4395.4 4397.3 4479.7 4482.3 4484.4 5226.6 5227.5 5236.7 5247.6 5258.3 4345.9 4499.5 4509.4 4518.3 4519.7 4595.5 4644.3 4661.0 4663.7 4682.3 4799.0 4865.1 4872.7 4882.7 4896.8 5082.6 5152.3 5218.5 5240.9 5285.3 4781.0 4862.3 4862.9 4868.1 4880.4 5141.8 5149.0 5158.2 5171.6 5226.1 5038.3 5076.6 5211.6 5221.6 5236.0 4848.6 4919.3 4921.0 4929.9 4992.4 4995.1 5017.1 5039.9 5045.6 5089.3 4816.0 4959.2 4984.7 4989.4 5014.1 4909.1 5011.5 5020.1 5038.0 5043.4 4868.2 4895.5 4920.8 4935.2 5001.3 07:22:33 INFO - PROCESS | 4758 | 07:22:33 INFO - PROCESS | 4758 | [#1] ext.html Cycles:180 Average:48425.84 Median:37033.32 stddev:89007.08 (240.3%) stddev-sans-first:89184.10 07:22:33 INFO - PROCESS | 4758 | Values: 522.9 594.0 598.1 599.4 615.2 35496.3 38594.8 38617.4 38705.4 38811.2 38942.6 39237.4 39526.0 39567.0 39653.8 7691.7 7817.5 7819.2 7825.3 7829.8 7724.3 7796.8 7807.8 7808.5 7826.9 7777.5 7791.7 7825.1 7833.8 7867.3 7777.5 7778.4 7778.7 7789.3 7798.4 7749.8 7772.2 7783.8 7786.1 7817.6 37593.0 38142.4 38272.8 38285.4 38385.6 2976.8 3073.0 3083.0 3202.9 3215.9 29323.7 29538.6 29998.0 30091.1 30844.0 3378.4 3379.2 3467.3 3473.4 3534.7 250703.0 251625.5 252223.0 252260.0 252839.0 54574.0 55083.2 55171.7 55291.0 55626.4 33223.2 33896.3 34469.8 36454.6 58481.7 14973.8 15048.8 15159.9 15185.9 15192.4 11393.9 11408.3 11490.1 11515.4 11524.3 18303.0 18583.6 18628.3 18671.9 18788.2 6877.3 6909.8 6915.2 7057.7 7064.4 791.1 860.3 999.6 1028.1 1034.9 29038.9 29407.2 29527.6 29552.3 29600.1 907.8 974.2 999.6 1003.3 1071.2 15012.4 15050.8 15132.7 15285.5 15458.8 395496.0 398950.0 400501.0 401530.0 402263.0 50436.0 50744.7 50889.5 50896.7 51054.7 1136.7 1198.2 1200.5 1218.2 1225.7 25916.2 27747.0 27755.0 27862.7 27985.9 42692.4 42857.6 42999.1 43143.6 43350.3 343163.0 344282.0 344578.0 345082.0 347226.0 25697.5 25926.6 26057.3 26250.2 26260.6 42251.6 43224.4 43308.0 43390.3 43442.3 36551.3 36844.0 36968.6 37386.4 37546.2 37159.4 37742.4 37835.0 37995.4 38016.8 32693.3 36230.1 36495.5 36933.1 37098.0 32042.5 33579.5 33732.0 33749.0 33912.7 26025.6 26154.2 26321.6 26373.3 26507.3 07:22:33 INFO - PROCESS | 4758 | 07:22:33 INFO - PROCESS | 4758 | [#2] jquery.html Cycles:180 Average:24859.95 Median:5104.58 stddev:66998.74 (1312.5%) stddev-sans-first:67161.44 07:22:33 INFO - PROCESS | 4758 | Values: 361.9 365.9 367.5 380.8 385.2 15800.8 15908.0 16003.9 16018.4 16758.6 16243.6 16763.2 17462.0 17475.2 17481.8 5107.2 5211.7 5264.7 5267.1 5279.3 3801.0 5161.9 5684.5 6009.7 6017.5 6048.8 6053.8 6067.3 6075.1 6100.5 5102.0 5383.4 5387.3 5401.3 5418.7 5198.6 5240.2 5285.5 5333.2 5341.3 20401.3 20641.0 20662.8 21183.8 21235.9 1934.0 1986.5 1989.4 2245.3 2298.7 9366.0 9611.2 12638.0 12682.5 13476.5 1586.8 1707.0 1717.6 1752.1 1763.3 67127.3 69429.7 70115.6 70365.3 71665.0 8442.4 8755.8 9101.8 9176.8 9487.3 12042.6 12102.7 12190.6 12295.1 12300.5 6749.9 6915.2 6918.7 6932.7 7093.1 6698.4 6782.9 6787.3 6939.5 6944.6 3841.9 3914.8 3916.5 3965.5 4004.9 1726.4 1749.6 1827.4 1882.6 1908.6 779.4 838.8 866.2 916.2 917.6 17119.1 17217.3 17361.6 17675.4 17720.2 865.4 869.0 878.5 881.5 891.5 9539.0 9813.0 9932.0 9935.4 9969.1 367207.0 367288.0 423252.0 430378.0 431469.0 79138.2 85853.6 86329.0 86604.1 87130.0 900.5 901.6 934.4 943.5 945.9 14357.1 15350.8 16131.4 16261.1 16886.3 26510.1 26708.0 26922.5 30981.0 36841.0 53670.0 53827.7 53889.0 54295.0 54591.7 6817.8 7908.6 7909.1 7994.7 8016.8 11770.4 11829.2 12397.4 12478.6 12553.1 9908.6 9972.5 9989.2 10358.6 10655.4 10809.6 10948.3 10981.0 11078.2 11216.9 10146.3 10160.2 10311.0 10326.2 10356.9 7234.4 7405.6 7418.3 7425.7 7459.1 9920.4 10324.7 10414.9 10882.7 10929.9 07:22:33 INFO - PROCESS | 4758 | 07:22:33 INFO - PROCESS | 4758 | [#3] mootools.html Cycles:180 Average:5165.74 Median:5046.75 stddev:2925.92 (58.0%) stddev-sans-first:2920.31 07:22:33 INFO - PROCESS | 4758 | Values: 1381.1 1425.3 1501.8 1695.4 1699.6 7003.7 7480.2 7743.0 8012.5 8060.9 7845.5 7869.0 7930.3 7941.7 7943.4 2200.8 2215.7 2234.7 2236.5 2237.9 2204.5 2236.2 2236.5 2238.0 2238.0 2206.6 2211.6 2219.1 2220.7 2231.1 2132.1 2157.8 2162.0 2169.8 2171.6 2176.3 2184.1 2184.9 2188.5 2190.7 7911.8 7996.5 8015.4 8029.1 8062.0 4480.6 4576.8 4578.3 4582.6 4616.5 2942.4 2953.1 2961.4 2998.7 3045.1 911.2 935.1 941.8 949.3 985.4 10620.5 10656.1 10687.2 10699.3 10718.1 4132.7 4298.6 4347.6 4420.4 4424.2 9125.6 9136.5 9151.1 9156.7 9203.2 4630.2 4639.5 4640.1 4641.9 4647.8 3798.1 4058.7 4185.1 4205.0 4213.2 3625.3 3727.5 3752.2 3826.6 3836.7 1147.8 1196.0 1213.6 1222.4 1223.6 844.8 846.4 847.6 866.4 870.2 5136.1 5273.5 5290.8 5302.5 5407.7 417.6 420.5 421.1 431.3 434.2 3503.4 3554.7 3586.2 3602.1 3627.6 9111.3 9834.0 9849.9 9855.4 9929.6 9554.7 9751.1 9807.5 9846.0 9849.1 7448.8 7517.8 7563.0 7564.4 7576.6 5029.6 5063.9 5101.2 5152.6 5289.3 8992.9 9043.6 9048.7 9104.3 9112.1 8860.8 9071.1 9409.5 9425.9 9438.5 6922.7 6960.4 7012.0 7060.9 7086.7 7543.3 7601.5 7607.1 7607.7 7641.9 6360.5 6436.6 6462.6 6525.7 6586.9 6685.4 6724.4 6731.9 6780.1 6882.4 6038.5 6065.3 6098.1 6113.8 6157.5 4505.6 4541.2 4608.7 4613.6 4634.4 4352.6 4370.3 4406.8 4435.1 4481.2 07:22:33 INFO - PROCESS | 4758 | 07:22:33 INFO - PROCESS | 4758 | [#4] prototype.html Cycles:180 Average:4407.85 Median:5046.65 stddev:1289.69 (25.6%) stddev-sans-first:1255.93 07:22:33 INFO - PROCESS | 4758 | Values: 300.8 301.5 307.3 308.1 310.1 5121.8 5138.0 5138.0 5145.4 5180.5 5029.4 5067.6 5073.4 5073.8 5090.3 3751.8 3874.7 3969.1 3973.9 3979.0 3956.3 3956.8 3974.1 3978.2 4009.2 3978.2 3984.7 3985.5 4010.1 4019.0 3726.5 3900.8 3909.0 4006.1 4017.0 3404.4 3428.1 3428.4 3429.4 3432.1 4942.9 4956.4 4970.7 4983.6 5005.8 4306.9 4519.9 4522.1 4528.5 4546.9 5288.8 5323.5 5340.4 5341.8 5343.2 3765.9 3774.1 3775.5 3775.8 3790.3 5394.9 5551.8 5576.5 5583.1 5610.3 3845.9 3862.9 3872.2 3875.2 3876.9 3873.5 3891.5 3903.9 3910.7 3921.8 4484.5 4501.1 4501.2 4501.6 4537.7 5174.7 5308.8 5337.7 5342.0 5374.1 1333.0 1334.7 1340.4 1345.3 1345.9 840.8 856.3 857.0 864.2 896.6 4611.5 4654.3 4659.5 4665.4 4673.6 5378.7 5422.0 5428.8 5461.3 5503.9 4518.7 4623.5 4627.9 4652.9 4669.5 2869.2 2878.8 2901.2 2910.7 2938.9 5049.4 5049.6 5068.1 5080.5 5089.0 5269.7 5514.5 5522.7 5529.6 5560.2 4985.8 5023.7 5023.8 5052.2 5056.3 5386.1 5416.9 5424.8 5427.3 5466.7 5087.3 5194.6 5305.5 5312.3 5313.6 5026.9 5045.6 5047.7 5078.6 5090.4 3825.7 3837.3 3843.5 3862.2 3871.7 5241.6 5481.9 5550.6 5556.6 5572.8 5417.9 5418.8 5427.9 5450.2 5464.2 5229.5 5347.0 5415.0 5420.7 5453.3 5318.9 5335.7 5341.4 5345.4 5399.6 5215.3 5217.9 5414.7 5428.8 5436.8 5286.7 5320.8 5324.3 5338.7 5350.5 07:22:33 INFO - PROCESS | 4758 | 07:22:33 INFO - PROCESS | 4758 | [#5] yui.html Cycles:180 Average:16766.81 Median:53423.83 stddev:23078.03 (43.2%) stddev-sans-first:23110.99 07:22:33 INFO - PROCESS | 4758 | Values: 635.2 639.5 668.6 704.2 735.1 11946.5 12597.8 12608.9 12624.7 12655.3 13198.5 13654.5 14377.0 14386.9 14395.6 638.0 774.0 781.1 798.1 802.5 790.9 808.1 809.7 811.0 811.3 859.2 861.7 861.8 862.3 863.3 843.6 846.9 849.5 850.0 850.7 622.1 624.5 626.1 626.2 628.9 14442.2 14578.0 14596.4 14614.7 14662.3 14181.7 14254.3 14328.1 14365.1 14376.0 10373.7 10524.5 10660.2 11051.8 11257.7 3363.1 3368.9 3387.7 3459.0 3490.4 58531.0 59025.7 59806.1 59937.4 59972.4 10807.6 10911.3 11176.6 11306.8 11792.9 19893.5 20299.3 20379.7 20407.1 20463.9 7209.7 7255.5 7365.6 7490.0 7539.9 3718.6 3821.8 3859.7 3870.9 3887.9 2904.8 2980.5 2995.1 3001.5 3018.9 513.6 517.4 523.2 526.2 532.3 503.4 621.3 633.5 636.1 638.5 7751.6 7988.1 8106.2 8402.5 8618.6 590.9 618.3 625.5 641.6 656.0 3919.2 3987.6 3998.0 4002.2 4010.6 53205.5 53383.2 53464.5 56918.0 98918.0 82990.0 84159.6 84524.6 84558.0 86343.6 71400.0 72854.6 72949.0 73464.3 73468.0 7286.6 7340.6 7467.5 7469.7 7668.2 44414.3 46489.3 46499.3 47142.8 47599.5 61718.7 66352.0 67459.7 67524.0 67545.0 9846.3 10087.2 10177.2 10192.3 10439.6 10175.1 10488.7 10623.4 10681.0 10720.7 10043.2 10065.8 10139.6 10273.8 10625.4 10616.5 10802.4 10872.3 10932.0 11078.7 9914.4 10316.4 10410.4 10462.3 10661.7 8735.5 8788.6 9063.5 9068.0 9085.9 8265.3 8868.5 8901.4 9007.0 9158.2 07:22:33 INFO - PROCESS | 4758 | -------- Summary: end -------- 07:22:33 INFO - PROCESS | 4758 | 07:22:33 INFO - TEST-INFO | 4758: exit 0 07:22:33 INFO - TEST-OK | dromaeo_css | took 1116411ms 07:22:33 INFO - TEST-START | kraken 07:22:33 INFO - operating with platform_type : linux_ 07:22:33 INFO - Initialising browser for kraken test... 07:22:33 INFO - TEST-INFO | started process 5004 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpEQ4Zk4/profile http://localhost:37786/getInfo.html) 07:22:38 INFO - PROCESS | 5004 | __metrics Screen width/height:1600/1200 07:22:38 INFO - PROCESS | 5004 | colorDepth:24 07:22:38 INFO - PROCESS | 5004 | Browser inner width/height: 1024/697 07:22:38 INFO - PROCESS | 5004 | __metrics 07:22:39 ERROR - PROCESS | 5004 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 07:22:40 INFO - TEST-INFO | 5004: exit 0 07:22:40 INFO - Browser initialized. 07:22:40 INFO - Running cycle 1/1 for kraken test... 07:22:40 INFO - TEST-INFO | started process 5122 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpEQ4Zk4/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:22:52 INFO - PROCESS | 5122 | RSS: Main: 169631744 07:22:52 INFO - PROCESS | 5122 | 07:22:55 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:37786/tests/kraken/driver.html?testName=audio-beat-detection) 07:22:56 INFO - PROCESS | 5122 | RSS: Main: 175345664 07:22:56 INFO - PROCESS | 5122 | 07:22:58 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:37786/tests/kraken/driver.html?testName=audio-dft) 07:22:59 INFO - PROCESS | 5122 | RSS: Main: 175120384 07:22:59 INFO - PROCESS | 5122 | 07:23:02 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:37786/tests/kraken/driver.html?testName=audio-fft) 07:23:02 INFO - PROCESS | 5122 | RSS: Main: 169545728 07:23:02 INFO - PROCESS | 5122 | 07:23:05 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:37786/tests/kraken/driver.html?testName=audio-oscillator) 07:23:05 INFO - PROCESS | 5122 | RSS: Main: 169598976 07:23:05 INFO - PROCESS | 5122 | 07:23:07 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:37786/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:23:08 INFO - PROCESS | 5122 | RSS: Main: 170356736 07:23:08 INFO - PROCESS | 5122 | 07:23:11 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:37786/tests/kraken/driver.html?testName=imaging-darkroom) 07:23:12 INFO - PROCESS | 5122 | RSS: Main: 170516480 07:23:12 INFO - PROCESS | 5122 | 07:23:15 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:37786/tests/kraken/driver.html?testName=imaging-desaturate) 07:23:16 INFO - PROCESS | 5122 | RSS: Main: 168464384 07:23:16 INFO - PROCESS | 5122 | 07:23:19 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:37786/tests/kraken/driver.html?testName=json-parse-financial) 07:23:20 INFO - PROCESS | 5122 | RSS: Main: 170049536 07:23:20 INFO - PROCESS | 5122 | 07:23:21 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:37786/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:23:22 INFO - PROCESS | 5122 | RSS: Main: 170459136 07:23:22 INFO - PROCESS | 5122 | 07:23:24 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:37786/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:23:25 INFO - PROCESS | 5122 | RSS: Main: 170364928 07:23:25 INFO - PROCESS | 5122 | 07:23:27 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:37786/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:23:28 INFO - PROCESS | 5122 | RSS: Main: 170512384 07:23:28 INFO - PROCESS | 5122 | 07:23:30 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:37786/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:23:31 INFO - PROCESS | 5122 | RSS: Main: 171085824 07:23:31 INFO - PROCESS | 5122 | 07:23:34 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:37786/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:23:34 INFO - PROCESS | 5122 | RSS: Main: 170196992 07:23:34 INFO - PROCESS | 5122 | 07:23:36 INFO - PROCESS | 5122 | Cycle 1(1): loaded http://localhost:37786/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:37786/tests/kraken/driver.html?testName=ai-astar) 07:23:36 INFO - PROCESS | 5122 | RSS: Main: 171319296 07:23:36 INFO - PROCESS | 5122 | 07:23:36 INFO - PROCESS | 5122 | __start_tp_report 07:23:36 INFO - PROCESS | 5122 | _x_x_mozilla_page_load 07:23:36 INFO - PROCESS | 5122 | _x_x_mozilla_page_load_details 07:23:36 INFO - PROCESS | 5122 | |i|pagename|runs| 07:23:36 INFO - PROCESS | 5122 | |0;ai-astar;105;114;113;117;116;116;118;118;113;115 07:23:36 INFO - PROCESS | 5122 | |1;audio-beat-detection;155;124;149;169;125;145;143;138;174;124 07:23:36 INFO - PROCESS | 5122 | |2;audio-dft;163;165;165;168;170;166;163;165;164;164 07:23:36 INFO - PROCESS | 5122 | |3;audio-fft;76;75;76;161;78;77;77;76;154;77 07:23:36 INFO - PROCESS | 5122 | |4;audio-oscillator;85;85;140;86;86;85;131;86;86;138 07:23:36 INFO - PROCESS | 5122 | |5;imaging-gaussian-blur;118;118;117;118;118;118;119;117;122;118 07:23:36 INFO - PROCESS | 5122 | |6;imaging-darkroom;149;148;150;148;149;148;148;148;149;148 07:23:36 INFO - PROCESS | 5122 | |7;imaging-desaturate;96;95;96;95;95;96;96;95;96;95 07:23:36 INFO - PROCESS | 5122 | |8;json-parse-financial;67;67;64;64;67;65;65;65;64;65 07:23:36 INFO - PROCESS | 5122 | |9;json-stringify-tinderbox;65;64;65;65;65;65;66;64;65;64 07:23:36 INFO - PROCESS | 5122 | |10;stanford-crypto-aes;82;79;78;83;81;86;85;79;84;80 07:23:36 INFO - PROCESS | 5122 | |11;stanford-crypto-ccm;132;127;137;138;136;137;144;140;185;144 07:23:36 INFO - PROCESS | 5122 | |12;stanford-crypto-pbkdf2;173;166;165;166;164;169;168;171;166;166 07:23:36 INFO - PROCESS | 5122 | |13;stanford-crypto-sha256-iterative;68;68;71;67;67;66;67;69;68;66 07:23:36 INFO - PROCESS | 5122 | __end_tp_report 07:23:36 INFO - PROCESS | 5122 | __start_cc_report 07:23:36 INFO - PROCESS | 5122 | _x_x_mozilla_cycle_collect,1001 07:23:36 INFO - PROCESS | 5122 | __end_cc_report 07:23:36 INFO - PROCESS | 5122 | __startTimestamp1467383016982__endTimestamp 07:23:36 INFO - PROCESS | 5122 | 07:23:36 INFO - PROCESS | 5122 | ------- Summary: start ------- 07:23:36 INFO - PROCESS | 5122 | Number of tests: 14 07:23:36 INFO - PROCESS | 5122 | 07:23:36 INFO - PROCESS | 5122 | [#0] ai-astar Cycles:10 Average:114.50 Median:116.00 stddev:3.81 (3.3%) stddev-sans-first:1.94 07:23:36 INFO - PROCESS | 5122 | Values: 105.0 114.0 113.0 117.0 116.0 116.0 118.0 118.0 113.0 115.0 07:23:36 INFO - PROCESS | 5122 | 07:23:36 INFO - PROCESS | 5122 | [#1] audio-beat-detection Cycles:10 Average:144.60 Median:147.00 stddev:17.85 (12.1%) stddev-sans-first:18.53 07:23:36 INFO - PROCESS | 5122 | Values: 155.0 124.0 149.0 169.0 125.0 145.0 143.0 138.0 174.0 124.0 07:23:36 INFO - PROCESS | 5122 | 07:23:36 INFO - PROCESS | 5122 | [#2] audio-dft Cycles:10 Average:165.30 Median:165.00 stddev:2.21 (1.3%) stddev-sans-first:2.19 07:23:36 INFO - PROCESS | 5122 | Values: 163.0 165.0 165.0 168.0 170.0 166.0 163.0 165.0 164.0 164.0 07:23:36 INFO - PROCESS | 5122 | 07:23:36 INFO - PROCESS | 5122 | [#3] audio-fft Cycles:10 Average:92.70 Median:76.50 stddev:34.20 (44.7%) stddev-sans-first:35.74 07:23:36 INFO - PROCESS | 5122 | Values: 76.0 75.0 76.0 161.0 78.0 77.0 77.0 76.0 154.0 77.0 07:23:37 INFO - PROCESS | 5122 | 07:23:37 INFO - PROCESS | 5122 | [#4] audio-oscillator Cycles:10 Average:100.80 Median:85.50 stddev:24.63 (28.8%) stddev-sans-first:25.45 07:23:37 INFO - PROCESS | 5122 | Values: 85.0 85.0 140.0 86.0 86.0 85.0 131.0 86.0 86.0 138.0 07:23:37 INFO - PROCESS | 5122 | 07:23:37 INFO - PROCESS | 5122 | [#5] imaging-gaussian-blur Cycles:10 Average:118.30 Median:118.00 stddev:1.42 (1.2%) stddev-sans-first:1.50 07:23:37 INFO - PROCESS | 5122 | Values: 118.0 118.0 117.0 118.0 118.0 118.0 119.0 117.0 122.0 118.0 07:23:37 INFO - PROCESS | 5122 | 07:23:37 INFO - PROCESS | 5122 | [#6] imaging-darkroom Cycles:10 Average:148.50 Median:148.50 stddev:0.71 (0.5%) stddev-sans-first:0.73 07:23:37 INFO - PROCESS | 5122 | Values: 149.0 148.0 150.0 148.0 149.0 148.0 148.0 148.0 149.0 148.0 07:23:37 INFO - PROCESS | 5122 | 07:23:37 INFO - PROCESS | 5122 | [#7] imaging-desaturate Cycles:10 Average:95.50 Median:96.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 07:23:37 INFO - PROCESS | 5122 | Values: 96.0 95.0 96.0 95.0 95.0 96.0 96.0 95.0 96.0 95.0 07:23:37 INFO - PROCESS | 5122 | 07:23:37 INFO - PROCESS | 5122 | [#8] json-parse-financial Cycles:10 Average:65.30 Median:65.00 stddev:1.25 (1.9%) stddev-sans-first:1.17 07:23:37 INFO - PROCESS | 5122 | Values: 67.0 67.0 64.0 64.0 67.0 65.0 65.0 65.0 64.0 65.0 07:23:37 INFO - PROCESS | 5122 | 07:23:37 INFO - PROCESS | 5122 | [#9] json-stringify-tinderbox Cycles:10 Average:64.80 Median:65.00 stddev:0.63 (1.0%) stddev-sans-first:0.67 07:23:37 INFO - PROCESS | 5122 | Values: 65.0 64.0 65.0 65.0 65.0 65.0 66.0 64.0 65.0 64.0 07:23:37 INFO - PROCESS | 5122 | 07:23:37 INFO - PROCESS | 5122 | [#10] stanford-crypto-aes Cycles:10 Average:81.70 Median:82.50 stddev:2.75 (3.3%) stddev-sans-first:2.92 07:23:37 INFO - PROCESS | 5122 | Values: 82.0 79.0 78.0 83.0 81.0 86.0 85.0 79.0 84.0 80.0 07:23:37 INFO - PROCESS | 5122 | 07:23:37 INFO - PROCESS | 5122 | [#11] stanford-crypto-ccm Cycles:10 Average:142.00 Median:139.00 stddev:15.94 (11.5%) stddev-sans-first:16.50 07:23:37 INFO - PROCESS | 5122 | Values: 132.0 127.0 137.0 138.0 136.0 137.0 144.0 140.0 185.0 144.0 07:23:37 INFO - PROCESS | 5122 | 07:23:37 INFO - PROCESS | 5122 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:167.40 Median:167.00 stddev:2.84 (1.7%) stddev-sans-first:2.17 07:23:37 INFO - PROCESS | 5122 | Values: 173.0 166.0 165.0 166.0 164.0 169.0 168.0 171.0 166.0 166.0 07:23:37 INFO - PROCESS | 5122 | 07:23:37 INFO - PROCESS | 5122 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.70 Median:68.00 stddev:1.49 (2.2%) stddev-sans-first:1.58 07:23:37 INFO - PROCESS | 5122 | Values: 68.0 68.0 71.0 67.0 67.0 66.0 67.0 69.0 68.0 66.0 07:23:37 INFO - PROCESS | 5122 | -------- Summary: end -------- 07:23:37 INFO - PROCESS | 5122 | 07:23:37 INFO - TEST-INFO | 5122: exit 0 07:23:38 INFO - TEST-OK | kraken | took 64151ms 07:23:38 INFO - SUITE-END | took 1180s 07:23:38 INFO - Completed test suite (00:19:40) 07:23:38 INFO - javascript benchmark 07:23:38 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6464.267531262206, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2598.298459415958, 2645.2989957661234, 2657.3888005758677, 2681.5307321218793, 2681.9463610727785, 4826.8069277228915, 4850.9514904850985, 4883.29192267121, 4907.582855457282, 4922.901541969159, 4727.1254817858635, 4765.952340476594, 4787.832425865086, 4811.061842940628, 4870.0, 4321.481422229337, 4396.472423309207, 4454.3318502224765, 4456.59890609845, 4488.236999710057, 4444.044530425957, 4513.277875539914, 4530.456345238576, 4552.9089418211615, 4572.977135114336, 4249.383839343293, 4264.211120942636, 4311.094670119279, 4349.173657005159, 4388.319810429357, 4333.783310834446, 4407.823687052514, 4436.401085853401, 4441.067375851075, 4447.08834688888, 4374.103308821684, 4391.385206071152, 4423.845165419227, 4430.468343798732, 4443.800028998703, 4782.976085119587, 4871.902561948777, 4873.02539492103, 4880.487548807359, 4926.975365123188, 5213.973930130363, 5215.035218484592, 5224.03355379256, 5244.685318880879, 5254.658447200958, 4984.700917944935, 5147.794088236466, 5172.870678233036, 5185.922211166836, 5203.60972927032, 4822.493638168012, 4835.661503694742, 4859.392575928009, 4899.436564795023, 4916.680415772963, 5336.092864213093, 5340.06548853949, 5350.143976963667, 5354.518093371616, 5359.330083739533, 4986.276989836453, 4996.400431948189, 5030.597552195815, 5060.671056381323, 5136.178211486144, 5079.390473143247, 5121.129408000649, 5153.3815942087185, 5181.119209734355, 5201.713905735221, 5089.236614507779, 5093.159628661229, 5126.846194614168, 5130.615203859726, 5135.229715542624, 4998.450170481244, 5021.5229553192385, 5048.444671086178, 5094.032133894548, 5139.152039913447, 4343.370211319341, 4344.391785150082, 4346.695731298779, 4357.7385356878685, 4402.471703395613, 3803.0897620585056, 3812.989557767194, 3827.827747751358, 3829.885103446901, 3842.538895332578, 4395.406620106309, 4397.2964325707735, 4479.731216127043, 4482.327650852333, 4484.439445069366, 5226.608004399685, 5227.529522342931, 5236.6857988520815, 5247.606429517801, 5258.316418865523, 4345.891352716208, 4499.482559505699, 4509.368688383629, 4518.322251662277, 4519.683622146418, 4595.517470665532, 4644.349791029259, 4661.0, 4663.650226233046, 4682.321063445849, 4798.95201047985, 4865.1242776300605, 4872.6589138761365, 4882.707037577757, 4896.804127834846, 5082.567981721447, 5152.252923326172, 5218.504242096995, 5240.947590524046, 5285.339332583427, 4780.976095119502, 4862.31927530139, 4862.927056094232, 4868.099401610713, 4880.389951256093, 5141.7686204120155, 5149.021685879671, 5158.226266060121, 5171.63798534099, 5226.11156103471, 5038.294638750651, 5076.568491678248, 5211.635185536976, 5221.582273418194, 5236.031334203185, 4848.5636292732415, 4919.311296418433, 4921.04039712267, 4929.901401971869, 4992.375953005874, 4995.100881841304, 5017.147084995632, 5039.949600503948, 5045.571126454292, 5089.287499750112, 4816.0, 4959.156943319572, 4984.651074424755, 4989.376327959005, 5014.147594908802, 4909.140900342497, 5011.5489605935645, 5020.071286811952, 5037.974810125926, 5043.420006699276, 4868.2210846264425, 4895.46149923501, 4920.803167873388, 4935.235038569028, 5001.299818025406], "value": 4733.213666328514, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [522.8793830932633, 593.9792107276246, 598.0520874414053, 599.3646734461469, 615.2186722861968, 35496.290074198536, 38594.8070259649, 38617.42073868894, 38705.419418708705, 38811.22377552447, 38942.61057389425, 39237.41143882837, 39526.0, 39567.0, 39653.801730991305, 7691.730789422385, 7817.491863028913, 7819.218078192163, 7825.256600622932, 7829.765107046797, 7724.34343080836, 7796.844063118734, 7807.765767026998, 7808.5314881107315, 7826.921730782677, 7777.494462859924, 7791.688332466694, 7825.060992680887, 7833.804154896145, 7867.252611001945, 7777.533347999138, 7778.3777297816605, 7778.6888524458955, 7789.298963093349, 7798.376129909594, 7749.806254843617, 7772.222777722182, 7783.805404864867, 7786.1435242123325, 7817.648205830695, 37593.0, 38142.42786358207, 38272.808635956644, 38285.42571861424, 38385.61614383848, 2976.821390716564, 3072.9692703072906, 3083.04425628056, 3202.9199270018203, 3215.855286512089, 29323.70676293231, 29538.55692164619, 29998.0, 30091.097267081805, 30844.0, 3378.3581119587448, 3379.2227787608986, 3467.2718729066673, 3473.426884564044, 3534.68187863091, 250703.0, 251625.48374516203, 252223.0, 252260.0, 252839.0, 54574.0, 55083.17375239375, 55171.72414137984, 55291.0, 55626.443735562934, 33223.16942076419, 33896.32207355839, 34469.827650862084, 36454.63545364566, 58481.70759146262, 14973.775393369107, 15048.849511504965, 15159.924200379148, 15185.924070379577, 15192.392304307925, 11393.943030284961, 11408.258463199865, 11490.138239631893, 11515.366654833897, 11524.250923689933, 18303.0, 18583.628327433376, 18628.254869805056, 18671.90664046671, 18788.248470061317, 6877.346652068046, 6909.75815846453, 6915.239323674392, 7057.717691292393, 7064.43484521237, 791.133708589094, 860.2558786649503, 999.6351331763854, 1028.0747327405395, 1034.9223808214415, 29038.854805725838, 29407.1540900129, 29527.55708664372, 29552.261193469905, 29600.111996640135, 907.8320510705408, 974.2352253481125, 999.6201443451442, 1003.3277703938379, 1071.212658695858, 15012.399504019717, 15050.774238386433, 15132.697346053017, 15285.465008724641, 15458.84541154574, 395496.0, 398950.0, 400501.0, 401530.0, 402263.0, 50436.0, 50744.74627626838, 50889.49110508922, 50896.74551627218, 51054.744726276134, 1136.687410961992, 1198.2391181599746, 1200.4717924113363, 1218.1716432825585, 1225.7140433092397, 25916.222513324632, 27747.0, 27755.0, 27862.721372786014, 27985.86007070033, 42692.35961460643, 42857.57142428536, 42999.14001720011, 43143.56856431521, 43350.34974475322, 343163.0, 344282.0, 344578.0, 345082.0, 347226.0, 25697.486050278516, 25926.61110083388, 26057.348566285993, 26250.212493625222, 26260.60609090827, 42251.57748422599, 43224.35163472613, 43308.0, 43390.34914476222, 43442.34836477392, 36551.26897462089, 36844.0, 36968.63031369652, 37386.43920341251, 37546.249075018895, 37159.44260836144, 37742.43386349262, 37835.0, 37995.43006854955, 38016.809915950245, 32693.34613307768, 36230.09424764402, 36495.45256821097, 36933.076673083386, 37098.0, 32042.51936220912, 33579.49630755589, 33732.0, 33749.0, 33912.660873391935, 26025.6096158554, 26154.215373538824, 26321.60517592276, 26373.34066648349, 26507.33731656724], "value": 17659.74197460476, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [361.94208926571747, 365.8865751616999, 367.5332327943512, 380.7516614392014, 385.2141631072612, 15800.762988555181, 15908.0, 16003.919980400111, 16018.359265629375, 16758.581035474104, 16243.593910152253, 16763.24565394557, 17462.0, 17475.213615387307, 17481.82518174818, 5107.182850743891, 5211.661242019276, 5264.710440925747, 5267.104592219332, 5279.2872962150195, 3800.9809950950207, 5161.896762064756, 5684.488396044355, 6009.669468179271, 6017.458428741413, 6048.818535443944, 6053.848653783669, 6067.332593414743, 6075.149479072933, 6100.511959043266, 5101.974490127563, 5383.43473935237, 5387.299651045359, 5401.297831281908, 5418.729063546807, 5198.558122559587, 5240.213967904845, 5285.524302812765, 5333.173358129496, 5341.278927344798, 20401.285954991654, 20641.0, 20662.793372066237, 21183.788162118337, 21235.893820530953, 1934.0, 1986.4835142862814, 1989.3932350633052, 2245.315178870444, 2298.679376427369, 9366.0, 9611.183049440806, 12638.0, 12682.492700291978, 13476.460941562325, 1586.8333824948445, 1706.9658606827918, 1717.6392957478945, 1752.1151818331662, 1763.2682436788718, 67127.3287267126, 69429.65285173593, 70115.64942175256, 70365.2963470369, 71665.0, 8442.409031367746, 8755.824883502422, 9101.81796364069, 9176.770580735534, 9487.33588648788, 12042.578509752117, 12102.697432564257, 12190.634280971584, 12295.077869159848, 12300.507979680713, 6749.8650026999185, 6915.239323674392, 6918.7232510699005, 6932.6533673316135, 7093.1488221413765, 6698.363655452724, 6782.8643427132165, 6787.321267873173, 6939.514234003571, 6944.618046007518, 3841.9039524012123, 3914.823832927525, 3916.5104361954754, 3965.464662270614, 4004.9199016019516, 1726.4389073551147, 1749.588846621043, 1827.378691244983, 1882.5575989642423, 1908.5801123752751, 779.3570304498697, 838.7861095420628, 866.1728049712635, 916.2349438219028, 917.5870858113875, 17119.14404279781, 17217.31130754756, 17361.56596085108, 17675.381361652282, 17720.20259088344, 865.3899001204136, 868.9826203475895, 878.5255961780695, 881.5371929736939, 891.4517571693361, 9539.0, 9813.0, 9932.0, 9935.354201976848, 9969.052939970692, 367207.0, 367288.0, 423252.0, 430378.0, 431469.0, 79138.20861791309, 85853.57073214593, 86329.0, 86604.1339586596, 87130.0, 900.504722402676, 901.6438506789781, 934.3833070173653, 943.4952300519326, 945.8770359853175, 14357.066790658573, 15350.846491534941, 16131.435399760952, 16261.105639189958, 16886.324547017983, 26510.072147474744, 26708.0, 26922.461550769265, 30981.0, 36841.0, 53670.0, 53827.730861345444, 53889.0, 54295.0, 54591.72704136454, 6817.829554261183, 7908.604569771604, 7909.05091389037, 7994.720184793504, 8016.83966320682, 11770.3526306054, 11829.231099978473, 12397.380130993595, 12478.563250286197, 12553.121281510206, 9908.554115064984, 9972.50137493137, 9989.150922171697, 10358.585656573954, 10655.413952232391, 10809.56761729522, 10948.288361256493, 10981.0, 11078.224524283223, 11216.887831121585, 10146.340487868265, 10160.23798215122, 10311.014263074425, 10326.173906087344, 10356.948215258875, 7234.385077268491, 7405.555666659802, 7418.258174182539, 7425.70297188128, 7459.142198647008, 9920.355176913477, 10324.741881453023, 10414.895851041392, 10882.673519794418, 10929.945350273198], "value": 8243.208407822625, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1381.0608786025505, 1425.33721819354, 1501.7822415749717, 1695.4150817967811, 1699.5836020175052, 7003.684834182462, 7480.177180510146, 7743.0, 8012.479188852721, 8060.919390806091, 7845.450818442711, 7868.960655196716, 7930.286274235317, 7941.722039728611, 7943.443958922863, 2200.7909248621354, 2215.7230346206725, 2234.731832180141, 2236.541508990653, 2237.944051398712, 2204.459907322708, 2236.2396785093065, 2236.5079682469914, 2237.9776202238013, 2237.9888100559474, 2206.6138425775507, 2211.6019116559014, 2219.079082180893, 2220.7224096987875, 2231.0518029837335, 2132.1258284103596, 2157.751858536265, 2162.027087810484, 2169.8155656769195, 2171.576542574199, 2176.3470958712323, 2184.071769497957, 2184.90167942443, 2188.5075857931997, 2190.7042549255966, 7911.762647120596, 7996.520208787491, 8015.398845086642, 8029.116797152308, 8061.95969020157, 4480.641548676098, 4576.794044268016, 4578.2903649934315, 4582.6104781093645, 4616.53834616539, 2942.440936222111, 2953.069783018342, 2961.392914452532, 2998.6551546572205, 3045.1321373408696, 911.2072496927649, 935.1023017902821, 941.8210539997447, 949.3070058857073, 985.3693636072919, 10620.46897655122, 10656.09423199029, 10687.198460115522, 10699.304545204537, 10718.142548596172, 4132.690048246393, 4298.591633794785, 4347.630451411602, 4420.447444069491, 4424.225760491901, 9125.634974600942, 9136.497492637836, 9151.130642588943, 9156.725298241063, 9203.217726493189, 4630.189716799547, 4639.536046395401, 4640.141573808789, 4641.930371044437, 4647.790849411785, 3798.1074447504816, 4058.6753059755147, 4185.121124563815, 4205.0, 4213.220554197484, 3625.329314076904, 3727.459518369821, 3752.249550089993, 3826.6364695353896, 3836.67388272, 1147.822087576427, 1196.0, 1213.611644273824, 1222.4010234984794, 1223.565634199864, 844.7550210439027, 846.3863698818308, 847.6439895244013, 866.4108406283661, 870.1776820904312, 5136.126858434075, 5273.499017593323, 5290.81482148123, 5302.496262855023, 5407.729613519308, 417.611621192288, 420.5416096454879, 421.1408726198521, 431.25393069989093, 434.1902352113349, 3503.4394496880377, 3554.733394995386, 3586.2110335726097, 3602.1174812171184, 3627.637236276404, 9111.316651251183, 9834.0, 9849.901500985041, 9855.35940163887, 9929.602815887283, 9554.713358599252, 9751.073648003428, 9807.460589667495, 9845.950770246103, 9849.064338887794, 7448.813779655552, 7517.812054698677, 7562.962185189149, 7564.357029652431, 7576.5832879191075, 5029.622778291716, 5063.87340316495, 5101.20931255656, 5152.5620322271525, 5289.312389389354, 8992.910070899206, 9043.63825447001, 9048.683296084606, 9104.317176211678, 9112.088791120836, 8860.778480538038, 9071.09289071114, 9409.529523523659, 9425.905740942777, 9438.48088355147, 6922.688479018557, 6960.408365288805, 7012.018317435665, 7060.858782824212, 7086.716531338689, 7543.283388078124, 7601.543907365576, 7607.125180604301, 7607.657655405631, 7641.923580764121, 6360.49116070704, 6436.6459844707115, 6462.644554549545, 6525.7063432146615, 6586.868262634624, 6685.364890335411, 6724.361185687352, 6731.865362692621, 6780.050792889098, 6882.414994725505, 6038.456538911519, 6065.302490213506, 6098.146259523582, 6113.816585502442, 6157.476614487819, 4505.594496495331, 4541.182587134347, 4608.700434471749, 4613.630909527163, 4634.351190833353, 4352.608265256015, 4370.300751879684, 4406.82372705101, 4435.068635586434, 4481.193385190697], "value": 4094.3802376266462, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [300.79846502843094, 301.5175718849841, 307.2533743004499, 308.0604157320173, 310.14864197777104, 5121.795128194873, 5138.0, 5138.0, 5145.4340022597535, 5180.45605211453, 5029.396472423315, 5067.619928505368, 5073.441921388644, 5073.771680274387, 5090.338256026721, 3751.7936513491745, 3874.748141370802, 3969.1267921057465, 3973.9006524836823, 3979.0, 3956.3076461619244, 3956.7823769692654, 3974.125692347679, 3978.1844721831953, 4009.158076803875, 3978.1645854370618, 3984.6812255019527, 3985.501812273466, 4010.0952047777364, 4018.959810401888, 3726.4782930389765, 3900.7854567998747, 3908.9804550977346, 4006.0585762345827, 4016.979915100435, 3404.42124838778, 3428.0915557377316, 3428.3828910796046, 3429.3998550253605, 3432.056184549244, 4942.87642808929, 4956.3804524434445, 4970.6520543561965, 4983.551480366748, 5005.799768009275, 4306.913861722779, 4519.864404067883, 4522.072975040109, 4528.50186479487, 4546.909061818778, 5288.81489147878, 5323.467653234646, 5340.359156901197, 5341.759620817073, 5343.225232341328, 3765.8870233893026, 3774.112943528236, 3775.528058992626, 3775.754575952554, 3790.336691079078, 5394.919076213899, 5551.77792888284, 5576.525995290405, 5583.106702927553, 5610.326760788691, 3845.8653947111716, 3862.903427414281, 3872.206197729459, 3875.1862108957434, 3876.8643097492018, 3873.4964454620717, 3891.494105766232, 3903.911407397086, 3910.687145028391, 3921.8039098044983, 4484.484284307347, 4501.051811063759, 4501.167284052461, 4501.594856462934, 4537.705049171794, 5174.663646863017, 5308.761105750251, 5337.653052551572, 5342.0, 5374.086405311106, 1332.9933350333185, 1334.726381091874, 1340.4169186403944, 1345.2735522817568, 1345.896364980726, 840.7687885831446, 856.2978357746713, 857.0, 864.1574464896676, 896.5875697179371, 4611.469680986663, 4654.325122857234, 4659.510751371125, 4665.440147182359, 4673.579377855941, 5378.731063446812, 5421.972890135524, 5428.7557059931605, 5461.290032295776, 5503.862403439946, 4518.661100417482, 4623.468301145344, 4627.8611641650805, 4652.860414187579, 4669.486356500782, 2869.153599688097, 2878.784091193169, 2901.2166714987256, 2910.6507219133414, 2938.8971386001813, 5049.394072711225, 5049.611356876888, 5068.138416469209, 5080.466551012164, 5088.9745551272745, 5269.710165940834, 5514.503694667499, 5522.696251706115, 5529.612927095065, 5560.193771903132, 4985.800567977313, 5023.7488125592845, 5023.8492845214705, 5052.191649336162, 5056.292119103328, 5386.084365657926, 5416.918746218731, 5424.80654256063, 5427.263275751721, 5466.671999680032, 5087.262346959744, 5194.558462530727, 5305.522502974751, 5312.335958005249, 5313.574914006793, 5026.924596130988, 5045.646804723634, 5047.662369472019, 5078.619103567321, 5090.440051594395, 3825.6556909878245, 3837.328467518229, 3843.4619153319118, 3862.2082473092387, 3871.670907972741, 5241.570872612636, 5481.890362192654, 5550.55595552363, 5556.611037227355, 5572.804951826666, 5417.891642167214, 5418.83743487696, 5427.945720542744, 5450.182472629137, 5464.207689885024, 5229.450907654794, 5347.0375332440535, 5415.0, 5420.674759514442, 5453.318335208099, 5318.883034562785, 5335.733213339395, 5341.35903691544, 5345.358556973188, 5399.568034557147, 5215.295935048872, 5217.921731173959, 5414.729263536886, 5428.83713488596, 5436.755346009518, 5286.656367336111, 5320.760565774472, 5324.281222034976, 5338.652987555796, 5350.5184533392185], "value": 3992.046268332843, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [635.1806170040647, 639.4532674563251, 668.6489592963694, 704.1690804850275, 735.0627949364559, 11946.522139114435, 12597.811032834492, 12608.936955315223, 12624.684382890433, 12655.303958282291, 13198.53805116821, 13654.52209172679, 14377.0, 14386.928065359685, 14395.568132956001, 637.9904301435482, 773.9883901741479, 781.1290411191509, 798.0981490915258, 802.5265093594778, 790.8853216283635, 808.0949336742827, 809.7165991902846, 810.9513429194237, 811.2820154163549, 859.1709000814213, 861.67687117331, 861.7845538615346, 862.3187681731456, 863.2662237098478, 843.6119385082869, 846.9280111190525, 849.4987957105276, 850.0479463001416, 850.7277671145235, 622.0700053420165, 624.4504835744516, 626.1328060636051, 626.1640709652619, 628.8805127025851, 14442.205678687667, 14578.0, 14596.416143354252, 14614.707705845929, 14662.26688665573, 14181.716365672732, 14254.287285635677, 14328.14031158134, 14365.13809171453, 14376.0, 10373.651425314736, 10524.47377631123, 10660.200484963581, 11051.778964420666, 11257.71855703614, 3363.091965169415, 3368.9326213475592, 3387.7459190560808, 3459.0141809584147, 3490.354284457358, 58531.0, 59025.7048714758, 59806.10290845641, 59937.40062599405, 59972.400275997556, 10807.567697292021, 10911.290766100337, 11176.608818691308, 11306.830397544043, 11792.88207117935, 19893.502662433555, 20299.28952486656, 20379.694304585442, 20407.081681324376, 20463.8976805118, 7209.747658831916, 7255.52839065459, 7365.558066515919, 7490.0, 7539.886901696479, 3718.5537735471917, 3821.8471261149243, 3859.710521710883, 3870.9225815484097, 3887.8639247626197, 2904.796664233483, 2980.478416277143, 2995.1164406500134, 3001.5347621118763, 3018.879244830226, 513.586562816936, 517.3817288340397, 523.233462976741, 526.2211926349025, 532.2893936594612, 503.3632454944498, 621.3134486392562, 633.5121956093782, 636.096742625473, 638.4732595608549, 7751.612419379008, 7988.081370642334, 8106.189381061965, 8402.453840500348, 8618.569071546397, 590.8611476303065, 618.2519151826251, 625.5452454595917, 641.6214433484266, 656.0, 3919.1573811630637, 3987.5813039631003, 3997.980010099989, 4002.1795531915886, 4010.6189911958318, 53205.46794532082, 53383.199252011254, 53464.46535534673, 56918.0, 98918.0, 82990.0, 84159.57920210483, 84524.57737711273, 84558.0, 86343.56828215819, 71400.0, 72854.63572682103, 72949.0, 73464.26535734574, 73468.0, 7286.562806231643, 7340.632968351668, 7467.477276590804, 7469.7012119516785, 7668.233176682287, 44414.3337849939, 46489.30266045944, 46499.30251046304, 47142.764286178346, 47599.52400475951, 61718.69140654447, 66352.0, 67459.66270168617, 67524.0, 67545.0, 9846.31075824714, 10087.24345674092, 10177.236707247133, 10192.337498062601, 10439.58241670355, 10175.084242418217, 10488.68533943983, 10623.36259824413, 10681.0, 10720.73198170052, 10043.196544276587, 10065.798684026426, 10139.594416223563, 10273.845892311472, 10625.362478251329, 10616.469176540988, 10802.351858888178, 10872.347659140476, 10932.0, 11078.667639970814, 9914.405135691593, 10316.381017138996, 10410.427426491615, 10462.267641265038, 10661.733456663334, 8735.475871447734, 8788.560571971504, 9063.456192628464, 9067.954660226656, 9085.863712044193, 8265.297449716601, 8868.512231827312, 8901.376903616685, 9007.0, 9158.221551168226], "value": 6478.0997856173, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1569.1000000000001, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 114.0, 113.0, 117.0, 116.0, 116.0, 118.0, 118.0, 113.0, 115.0], "value": 114.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 124.0, 149.0, 169.0, 125.0, 145.0, 143.0, 138.0, 174.0, 124.0], "value": 144.6, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 165.0, 165.0, 168.0, 170.0, 166.0, 163.0, 165.0, 164.0, 164.0], "value": 165.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 76.0, 161.0, 78.0, 77.0, 77.0, 76.0, 154.0, 77.0], "value": 92.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 140.0, 86.0, 86.0, 85.0, 131.0, 86.0, 86.0, 138.0], "value": 100.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 117.0, 118.0, 118.0, 118.0, 119.0, 117.0, 122.0, 118.0], "value": 118.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 148.0, 150.0, 148.0, 149.0, 148.0, 148.0, 148.0, 149.0, 148.0], "value": 148.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 95.0, 96.0, 95.0, 95.0, 96.0, 96.0, 95.0, 96.0, 95.0], "value": 95.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 67.0, 64.0, 64.0, 67.0, 65.0, 65.0, 65.0, 64.0, 65.0], "value": 65.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 64.0, 65.0, 65.0, 65.0, 65.0, 66.0, 64.0, 65.0, 64.0], "value": 64.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 79.0, 78.0, 83.0, 81.0, 86.0, 85.0, 79.0, 84.0, 80.0], "value": 81.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [132.0, 127.0, 137.0, 138.0, 136.0, 137.0, 144.0, 140.0, 185.0, 144.0], "value": 142.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [173.0, 166.0, 165.0, 166.0, 164.0, 169.0, 168.0, 171.0, 166.0, 166.0], "value": 167.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 68.0, 71.0, 67.0, 67.0, 66.0, 67.0, 69.0, 68.0, 66.0], "value": 67.7, "unit": "score"}]}]} 07:23:38 INFO - Return code: 0 07:23:38 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 07:23:38 ERROR - # TBPL SUCCESS # 07:23:38 INFO - Running post-action listener: _resource_record_post_action 07:23:38 INFO - ##### 07:23:38 INFO - ##### Finished run-tests step (success) 07:23:38 INFO - ##### 07:23:38 INFO - Running post-run listener: _resource_record_post_run 07:23:38 INFO - Total resource usage - Wall time: 1197s; CPU: 13.0%; Read bytes: 0; Write bytes: 546164736; Read time: 0; Write time: 474576 07:23:38 INFO - TinderboxPrint: CPU usage
13.3% 07:23:38 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 07:23:38 INFO - TinderboxPrint: I/O write bytes / time
546,164,736 / 474,576 07:23:38 INFO - TinderboxPrint: CPU idle
8,279.0 (86.7%) 07:23:38 INFO - TinderboxPrint: CPU user
1,217.4 (12.7%) 07:23:38 INFO - TinderboxPrint: Swap in / out
0 / 0 07:23:38 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 257204224; Read time: 0; Write time: 256180 07:23:38 INFO - run-tests - Wall time: 1181s; CPU: 13.0%; Read bytes: 0; Write bytes: 288452608; Read time: 0; Write time: 218368 07:23:38 INFO - Running post-run listener: _upload_blobber_files 07:23:38 INFO - Blob upload gear active. 07:23:38 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 07:23:38 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 07:23:38 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', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 07:23:38 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 Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 07:23:39 INFO - (blobuploader) - INFO - Open directory for files ... 07:23:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 07:23:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:23:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:23:40 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 07:23:40 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:23:40 INFO - (blobuploader) - INFO - Done attempting. 07:23:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 07:23:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:23:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:23:40 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 07:23:40 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:23:40 INFO - (blobuploader) - INFO - Done attempting. 07:23:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 07:23:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:23:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:23:44 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 07:23:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:23:44 INFO - (blobuploader) - INFO - Done attempting. 07:23:44 INFO - (blobuploader) - INFO - Iteration through files over. 07:23:44 INFO - Return code: 0 07:23:44 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 07:23:44 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 07:23:44 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/3f4dda85503fe9d7b1ebc4e9302561c1fcc4f971be5ed656f4e6c57acbdfa49d47704bf3846d4f41e8eff4640b1a51ceb993814360e68e982d5fc9440fd87120", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/22ffc439dc6c00e0da9d54e5fb98d76d089133aef8d611d9e2528cf80233f5b8ff682164c2b4eafeec6bfb4d0edb44056daaed53059da2d39a54ee42fb309560", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b58967377a99c225a3f9b05d3950cdb444cd9bc7575326d696d215896e57ba536e8d0bd185ecc2f03389c714b9824bd53d194bacd2362f46aef2d310a62296d9"} 07:23:44 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 07:23:44 INFO - Writing to file /builds/slave/test/properties/blobber_files 07:23:44 INFO - Contents: 07:23:44 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/3f4dda85503fe9d7b1ebc4e9302561c1fcc4f971be5ed656f4e6c57acbdfa49d47704bf3846d4f41e8eff4640b1a51ceb993814360e68e982d5fc9440fd87120", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/22ffc439dc6c00e0da9d54e5fb98d76d089133aef8d611d9e2528cf80233f5b8ff682164c2b4eafeec6bfb4d0edb44056daaed53059da2d39a54ee42fb309560", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b58967377a99c225a3f9b05d3950cdb444cd9bc7575326d696d215896e57ba536e8d0bd185ecc2f03389c714b9824bd53d194bacd2362f46aef2d310a62296d9"} 07:23:44 INFO - Running post-run listener: copy_logs_to_upload_dir 07:23:44 INFO - Copying logs to upload dir... 07:23:44 INFO - mkdir: /builds/slave/test/build/upload/logs 07:23:44 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1241.478837 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-07-01 07:23:43.987130) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-01 07:23:43.991055) ========= 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=db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895 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/Fx-Team-Non-PGO/sha512/3f4dda85503fe9d7b1ebc4e9302561c1fcc4f971be5ed656f4e6c57acbdfa49d47704bf3846d4f41e8eff4640b1a51ceb993814360e68e982d5fc9440fd87120", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/22ffc439dc6c00e0da9d54e5fb98d76d089133aef8d611d9e2528cf80233f5b8ff682164c2b4eafeec6bfb4d0edb44056daaed53059da2d39a54ee42fb309560", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b58967377a99c225a3f9b05d3950cdb444cd9bc7575326d696d215896e57ba536e8d0bd185ecc2f03389c714b9824bd53d194bacd2362f46aef2d310a62296d9"} build_url:https://queue.taskcluster.net/v1/task/aEVpAFIgTfGFGfoGvrnC9A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011359 build_url: 'https://queue.taskcluster.net/v1/task/aEVpAFIgTfGFGfoGvrnC9A/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/Fx-Team-Non-PGO/sha512/3f4dda85503fe9d7b1ebc4e9302561c1fcc4f971be5ed656f4e6c57acbdfa49d47704bf3846d4f41e8eff4640b1a51ceb993814360e68e982d5fc9440fd87120", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/22ffc439dc6c00e0da9d54e5fb98d76d089133aef8d611d9e2528cf80233f5b8ff682164c2b4eafeec6bfb4d0edb44056daaed53059da2d39a54ee42fb309560", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b58967377a99c225a3f9b05d3950cdb444cd9bc7575326d696d215896e57ba536e8d0bd185ecc2f03389c714b9824bd53d194bacd2362f46aef2d310a62296d9"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-01 07:23:44.016475) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 07:23:44.016828) ========= 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=db7e7c15f3ca076d53731445000001ba-1467380809.726257-790013895 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004473 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 07:23:44.100550) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-01 07:23:44.100873) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-01 07:23:44.101191) ========= ========= Total master_lag: 0.21 =========